0 Replies Latest reply on Nov 14, 2012 1:13 PM by 974207

    Error while executing Report migrated from 6i to 11g

    974207
      Hello,
      We have migrated forms & reports from 6i to 11g.
      Most of the reports work fine but we are having issue with very few reports.

      Let me explain the issue here:
      We have a Form that Runs a report.
      The Report has a PLL which loads a C library and calls a C Function. [using ORA_FFI]
      The C Function which is called has embedded SQL in it.
      The Report Server Engine crashes on encountering the first Executable SQL statement. [A Select or Insert]

      Need help to resolve this as we have tried a lot of things and not been successful.

      Below is a gist of the errors we see in teh Report server logs:

      "console~rep_test~1.log"
      Nov 14, 2012 7:37:11 AM com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl <init>
      WARNING: "IOP00410201: (COMM_FAILURE) Connection failure: socketType: IIOP_CLEAR_TEXT; hostname: 190.10.97.30; port: 57343"
      org.omg.CORBA.COMM_FAILURE: vmcid: SUN minor code: 201 completed: No
      at com.sun.corba.se.impl.logging.ORBUtilSystemException.connectFailure(ORBUtilSystemException.java:2200)
      at com.sun.corba.se.impl.logging.ORBUtilSystemException.connectFailure(ORBUtilSystemException.java:2221)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.<init>(SocketOrChannelConnectionImpl.java:205)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.<init>(SocketOrChannelConnectionImpl.java:218)
      at com.sun.corba.se.impl.transport.SocketOrChannelContactInfoImpl.createConnection(SocketOrChannelContactInfoImpl.java:101)
      at com.sun.corba.se.impl.protocol.CorbaClientRequestDispatcherImpl.beginRequest(CorbaClientRequestDispatcherImpl.java:152)
      at com.sun.corba.se.impl.protocol.CorbaClientDelegateImpl.request(CorbaClientDelegateImpl.java:118)
      at org.omg.CORBA.portable.ObjectImpl._request(ObjectImpl.java:431)
      at oracle.reports.engine._EngineClassStub.shutdown(_EngineClassStub.java:198)
      at oracle.reports.server.EngineManager.shutdownEngine(EngineManager.java:1748)
      at oracle.reports.server.JobManager.runJobInEngine(JobManager.java:1330)
      at oracle.reports.server.JobManager.runJobLocal(JobManager.java:2238)
      at oracle.reports.server.JobManager.dispatch(JobManager.java:1467)
      at oracle.reports.server.ConnectionImpl.runJob(ConnectionImpl.java:1537)
      at oracle.reports.server.ConnectionPOA._invoke(ConnectionPOA.java:460)
      at com.sun.corba.se.impl.protocol.CorbaServerRequestDispatcherImpl.dispatchToServant(CorbaServerRequestDispatcherImpl.java:637)
      at com.sun.corba.se.impl.protocol.CorbaServerRequestDispatcherImpl.dispatch(CorbaServerRequestDispatcherImpl.java:189)
      at com.sun.corba.se.impl.protocol.CorbaMessageMediatorImpl.handleRequestRequest(CorbaMessageMediatorImpl.java:1682)
      at com.sun.corba.se.impl.protocol.CorbaMessageMediatorImpl.handleRequest(CorbaMessageMediatorImpl.java:1540)
      at com.sun.corba.se.impl.protocol.CorbaMessageMediatorImpl.handleInput(CorbaMessageMediatorImpl.java:922)
      at com.sun.corba.se.impl.protocol.giopmsgheaders.RequestMessage_1_2.callback(RequestMessage_1_2.java:181)
      at com.sun.corba.se.impl.protocol.CorbaMessageMediatorImpl.handleRequest(CorbaMessageMediatorImpl.java:694)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.dispatch(SocketOrChannelConnectionImpl.java:451)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.doWork(SocketOrChannelConnectionImpl.java:1213)
      at com.sun.corba.se.impl.orbutil.threadpool.ThreadPoolImpl$WorkerThread.performWork(ThreadPoolImpl.java:471)
      at com.sun.corba.se.impl.orbutil.threadpool.ThreadPoolImpl$WorkerThread.run(ThreadPoolImpl.java:500)
      Caused by: java.net.ConnectException: Connection refused
      at sun.nio.ch.Net.connect(Native Method)
      at sun.nio.ch.SocketChannelImpl.connect(SocketChannelImpl.java:500)
      at java.nio.channels.SocketChannel.open(SocketChannel.java:146)
      at com.sun.corba.se.impl.transport.DefaultSocketFactoryImpl.createSocket(DefaultSocketFactoryImpl.java:60)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.<init>(SocketOrChannelConnectionImpl.java:188)
      ... 23 more

      ===============================================================================================================================

      "rwserver_diagnostic.log"

      [2012-11-14T07:37:10.969+01:00] [reports] [TRACE:16] [] [oracle.reports.server] [tid: 12] [ecid: 0000Jf_MXxPFg4^kxS3j7k1GbGIR000003,0] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] EngineManager:updateEngineState Engine rwEng-0 status is 3
      [2012-11-14T07:37:10.969+01:00] [reports] [NOTIFICATION:16] [REP-56004] [oracle.reports.server] [tid: 12] [ecid: 0000Jf_MXxPFg4^kxS3j7k1GbGIR000003,0] EngineInfo:setState Engine rwEng-0 state is: Running
      [2012-11-14T07:37:11.294+01:00] [reports] [INCIDENT_ERROR] [REP-50125] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [URI: /reports/rwservlet/showjobs] REP-50125 : org.omg.CORBA.COMM_FAILURE: vmcid: SUN minor code: 208 completed: Maybe [[
      org.omg.CORBA.COMM_FAILURE: vmcid: SUN minor code: 208 completed: Maybe
      at com.sun.corba.se.impl.logging.ORBUtilSystemException.connectionAbort(ORBUtilSystemException.java:2400)
      at com.sun.corba.se.impl.logging.ORBUtilSystemException.connectionAbort(ORBUtilSystemException.java:2418)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.readBits(SocketOrChannelConnectionImpl.java:354)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.handleEvent(SocketOrChannelConnectionImpl.java:1124)
      at com.sun.corba.se.impl.transport.SelectorImpl.run(SelectorImpl.java:289)
      Caused by: org.omg.CORBA.COMM_FAILURE: vmcid: SUN minor code: 211 completed: No
      at com.sun.corba.se.impl.logging.ORBUtilSystemException.ioexceptionWhenReadingConnection(ORBUtilSystemException.java:2484)
      at com.sun.corba.se.impl.logging.ORBUtilSystemException.ioexceptionWhenReadingConnection(ORBUtilSystemException.java:2502)
      at com.sun.corba.se.impl.protocol.giopmsgheaders.MessageBase.readGIOPHeader(MessageBase.java:116)
      at com.sun.corba.se.impl.transport.CorbaContactInfoBase.createMessageMediator(CorbaContactInfoBase.java:150)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.readBits(SocketOrChannelConnectionImpl.java:314)
      ... 2 more
      Caused by: java.io.IOException: End-of-stream
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.readFully(SocketOrChannelConnectionImpl.java:602)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.read(SocketOrChannelConnectionImpl.java:521)
      at com.sun.corba.se.impl.protocol.giopmsgheaders.MessageBase.readGIOPHeader(MessageBase.java:112)
      ... 4 more

      ]]
      [2012-11-14T07:37:11.296+01:00] [reports] [INCIDENT_ERROR] [REP-50125] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [URI: /reports/rwservlet/showjobs] REP-50125 : org.omg.CORBA.COMM_FAILURE: vmcid: SUN minor code: 201 completed: No [[
      org.omg.CORBA.COMM_FAILURE: vmcid: SUN minor code: 201 completed: No
      at com.sun.corba.se.impl.logging.ORBUtilSystemException.connectFailure(ORBUtilSystemException.java:2200)
      at com.sun.corba.se.impl.logging.ORBUtilSystemException.connectFailure(ORBUtilSystemException.java:2221)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.<init>(SocketOrChannelConnectionImpl.java:205)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.<init>(SocketOrChannelConnectionImpl.java:218)
      at com.sun.corba.se.impl.transport.SocketOrChannelContactInfoImpl.createConnection(SocketOrChannelContactInfoImpl.java:101)
      at com.sun.corba.se.impl.protocol.CorbaClientRequestDispatcherImpl.beginRequest(CorbaClientRequestDispatcherImpl.java:152)
      at com.sun.corba.se.impl.protocol.CorbaClientDelegateImpl.request(CorbaClientDelegateImpl.java:118)
      at org.omg.CORBA.portable.ObjectImpl._request(ObjectImpl.java:431)
      at oracle.reports.engine._EngineClassStub.shutdown(_EngineClassStub.java:198)
      at oracle.reports.server.EngineManager.shutdownEngine(EngineManager.java:1748)
      at oracle.reports.server.JobManager.runJobInEngine(JobManager.java:1330)
      at oracle.reports.server.JobManager.runJobLocal(JobManager.java:2238)
      at oracle.reports.server.JobManager.dispatch(JobManager.java:1467)
      at oracle.reports.server.ConnectionImpl.runJob(ConnectionImpl.java:1537)
      at oracle.reports.server.ConnectionPOA._invoke(ConnectionPOA.java:460)
      at com.sun.corba.se.impl.protocol.CorbaServerRequestDispatcherImpl.dispatchToServant(CorbaServerRequestDispatcherImpl.java:637)
      at com.sun.corba.se.impl.protocol.CorbaServerRequestDispatcherImpl.dispatch(CorbaServerRequestDispatcherImpl.java:189)
      at com.sun.corba.se.impl.protocol.CorbaMessageMediatorImpl.handleRequestRequest(CorbaMessageMediatorImpl.java:1682)
      at com.sun.corba.se.impl.protocol.CorbaMessageMediatorImpl.handleRequest(CorbaMessageMediatorImpl.java:1540)
      at com.sun.corba.se.impl.protocol.CorbaMessageMediatorImpl.handleInput(CorbaMessageMediatorImpl.java:922)
      at com.sun.corba.se.impl.protocol.giopmsgheaders.RequestMessage_1_2.callback(RequestMessage_1_2.java:181)
      at com.sun.corba.se.impl.protocol.CorbaMessageMediatorImpl.handleRequest(CorbaMessageMediatorImpl.java:694)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.dispatch(SocketOrChannelConnectionImpl.java:451)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.doWork(SocketOrChannelConnectionImpl.java:1213)
      at com.sun.corba.se.impl.orbutil.threadpool.ThreadPoolImpl$WorkerThread.performWork(ThreadPoolImpl.java:471)
      at com.sun.corba.se.impl.orbutil.threadpool.ThreadPoolImpl$WorkerThread.run(ThreadPoolImpl.java:500)
      Caused by: java.net.ConnectException: Connection refused
      at sun.nio.ch.Net.connect(Native Method)
      at sun.nio.ch.SocketChannelImpl.connect(SocketChannelImpl.java:500)
      at java.nio.channels.SocketChannel.open(SocketChannel.java:146)
      at com.sun.corba.se.impl.transport.DefaultSocketFactoryImpl.createSocket(DefaultSocketFactoryImpl.java:60)
      at com.sun.corba.se.impl.transport.SocketOrChannelConnectionImpl.<init>(SocketOrChannelConnectionImpl.java:188)
      ... 23 more

      [2012-11-14T07:37:11.297+01:00] [reports] [NOTIFICATION:16] [REP-56004] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [URI: /reports/rwservlet/showjobs] EngineInfo:setState Engine rwEng-0 state is: Shutdown
      [2012-11-14T07:37:11.297+01:00] [reports] [TRACE:32] [REP-56047] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] [URI: /reports/rwservlet/showjobs] EngineManager:remove Reports Server shut down engine rwEng-0.
      [2012-11-14T07:37:11.297+01:00] [reports] [TRACE:16] [] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] [URI: /reports/rwservlet/showjobs] JobManager:start Using Maximum Job Retry value = 0
      [2012-11-14T07:37:11.297+01:00] [reports] [NOTIFICATION:16] [REP-56016] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [URI: /reports/rwservlet/showjobs] JobManager:updateJobStatus Job 1658 status is: The report terminated with error: [[
      REP-56048: Engine rwEng-0 crashed., job Id: 1658.
      ]]
      [2012-11-14T07:37:11.297+01:00] [reports] [TRACE:16] [] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] [URI: /reports/rwservlet/showjobs] JobObject:writeLongUTF Number of Break Index values=1
      [2012-11-14T07:37:11.298+01:00] [reports] [TRACE:16] [] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] [URI: /reports/rwservlet/showjobs] JobObject:writeLongUTF String= Engine rwEng-0 crashed., job Id: 1658 strlen=37
      [2012-11-14T07:37:11.298+01:00] [reports] [TRACE:16] [] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] [URI: /reports/rwservlet/showjobs] JobManager:notifyWaitingJobs Master job 1658 notify its duplicated jobs.
      [2012-11-14T07:37:11.299+01:00] [reports] [TRACE:16] [] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] [URI: /reports/rwservlet/showjobs] JobManager:updateJobStatus Finished updating job: 1658
      [2012-11-14T07:37:11.299+01:00] [reports] [TRACE:16] [] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] [URI: /reports/rwservlet/showjobs] JobManager:runJobInEngine Encounted exception in job 1658
      [2012-11-14T07:37:11.299+01:00] [reports] [TRACE:16] [] [oracle.reports.server] [tid: 17] [ecid: 004nX0QrTwUFg4^kxS3j7k0005WT000k^s,0:1:0x5f5e639:100000000] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] [URI: /reports/rwservlet/showjobs] ConnectionImpl:runJob jobid = 1658 Failed with exceptionoracle.reports.RWException: IDL:oracle/reports/RWException:1.0
      [2012-11-14T07:37:11.318+01:00] [reports] [NOTIFICATION:16] [REP-56013] [oracle.reports.server] [tid: 12] [ecid: 0000Jf_MXxPFg4^kxS3j7k1GbGIR000003,0] ConnectionManager:release Connection 239 is released.
      [2012-11-14T07:37:11.382+01:00] [reports] [NOTIFICATION:16] [REP-56020] [oracle.reports.server] [tid: 13] [ecid: 0000Jf_MXxSFg4^kxS3j7k1GbGIR000004,0] EngineManager:spawnEngine Launching engine rwEng-0.
      [2012-11-14T07:37:11.382+01:00] [reports] [NOTIFICATION:16] [] [oracle.reports.server] [tid: 13] [ecid: 0000Jf_MXxSFg4^kxS3j7k1GbGIR000004,0] EngineManager:spawnEngine OS Name = Linux : OS Arch = amd64
      [2012-11-14T07:37:11.383+01:00] [reports] [TRACE:16] [] [oracle.reports.server] [tid: 13] [ecid: 0000Jf_MXxSFg4^kxS3j7k1GbGIR000004,0] [SRC_CLASS: oracle.reports.utility.RWLogger] [SRC_METHOD: writeln] EngineManager:spawnEngine Start engine command line = /utility/app/oracle/product/fmwfr/formsreports1/config/reports/bin/rwengine.sh -server -cp /utility/app/oracle/product/fmwfr/formsreports/reports/jlib/rwrun.jar -Dcomponent.path=rep_test -Doracle.reports.component=rwEng-0 -Dinprocess.server=false -Duser.language=it -Duser.region=IT -Xms512m -Xmx512m -Xss512k oracle.reports.engine.RWEngine name=rwEng-0 server=rep_test ORACLE_HOME=/utility/app/oracle/product/fmwfr/formsreports engineimplclass=oracle.reports.engine.EngineImpl cacheDir=/utility/app/oracle/product/fmwfr/formsreports1/reports/cache diagnosis="yes" keepConnection="yes" server_ior="/test/orafood/tmp/rep_test_129261664_1352875031383"
      [2012-11-14T07:37:11.386+01:00] [reports] [NOTIFICATION:16] [REP-56021] [oracle.reports.server] [tid: 13] [ecid: 0000Jf_MXxSFg4^kxS3j7k1GbGIR000004,0] EngineManager:spawnEngine Engine rwEng-0 has been launched.

      ====================================================================================================================

      Regards,
      KVS



      I can post the other logs if it helps.