To install point your Eclipse (Help->Software updates -> Find'n'Install -> New remote site) to https://jbossesbclipsevisualizer.googlecode.com/svn/trunk/update/
torstai 29. marraskuuta 2007
jboss-esb.xml visualizer tool for Eclipse
The preview version of an Eclipse plugin which allows to visualize the contents of jboss-esb.xml file is ready. See below for a screenshot.
To install point your Eclipse (Help->Software updates -> Find'n'Install -> New remote site) to https://jbossesbclipsevisualizer.googlecode.com/svn/trunk/update/
To install point your Eclipse (Help->Software updates -> Find'n'Install -> New remote site) to https://jbossesbclipsevisualizer.googlecode.com/svn/trunk/update/
tiistai 8. toukokuuta 2007
aggregator
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant deploy
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$
This is nice! It's always nice to get good feedback about what you have just done!
So let's try the standalone mode.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant
Bugger, didn't follow the instructions and forgot to manually deploy the JMS queues. The error message you get on the client side just doesn't tell you anything. The JBoss AS log contains the actual error message:
So, let deploy the JMS stuff before moving on.
1. In a command terminal window in the quickstart folder type 'ant deploy-jms-dests'
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant deploy-jms-dests
Then I used screen to create some virtual terminals and started up rest tasks.
3. Command Window 1: "ant run" - contains the splitter. It will display the entire XML message to its console
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant run
4. Command Window 2: "ant runRedService" - rips out just the Customer. It will display just the Customer information to its console.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runRedService
5. Command Window 3: "ant runGreenService" - rips out just the LineItems. It will display just the LineItems to its console
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runGreenService
6. Command Window 4: "ant runBlueService" - rips out just the OrderHeader. It will display just the Order header information to its console.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runBlueService
7. Command Window 5: "ant runAggregatorService" - displays the parts together. It will simply push out the individual message parts. More details on how that is achieved can be found below.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runAggregatorService
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runtest
However, RGB services seems to be working just fine. First the red service window.
Then green,
And Blue,
And finally, the aggreate service window
So finish up testing using the very convenient ant task to undeploy any installed JMS destinations and queues.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant undeploy-jms-dests
Buildfile: build.xml
deploy:
[echo]
[echo] ######################################################################
[echo] This quickstart can only run in standalone mode.
[echo] Please run 'ant help' for information about how to run this quickstart
[echo] ######################################################################
[echo]
BUILD SUCCESSFUL
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$
This is nice! It's always nice to get good feedback about what you have just done!
So let's try the standalone mode.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant
Buildfile: build.xml
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
[mkdir] Created dir: /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/build/classes
[javac] Compiling 12 source files to /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/build/classes
jar:
[jar] Building jar: /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/build/Quickstart_Aggregator.jar
run:
[echo] Inbound Router/Splitter:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/inbound_splitter/jbossesb.xml
[java] 00:15:39,558 ERROR [main][ConfigurationController] Unexpected exception starting controller
[java] org.jboss.soa.esb.listeners.lifecycle.ManagedLifecycleException: Unexpected JMS error from prepareMessageReceiver
[java] at org.jboss.soa.esb.listeners.gateway.JmsGatewayListener.doInitialise(JmsGatewayListener.java:113)
[java] at org.jboss.soa.esb.listeners.lifecycle.AbstractManagedLifecycle.initialise(AbstractManagedLifecycle.java:125)
[java] at org.jboss.soa.esb.listeners.lifecycle.ManagedLifecycleController.initialiseInstances(ManagedLifecycleController.java:164)
[java] at org.jboss.soa.esb.listeners.lifecycle.ManagedLifecycleController.start(ManagedLifecycleController.java:80)
[java] at org.jboss.soa.esb.listeners.config.ConfigurationController.processConfiguration(ConfigurationController.java:317)
[java] at org.jboss.soa.esb.listeners.config.ConfigurationController.(ConfigurationController.java:122)
[java] at org.jboss.soa.esb.listeners.StandAloneBootStrapper.initiateController(StandAloneBootStrapper.java:197)
[java] at org.jboss.soa.esb.listeners.StandAloneBootStrapper.(StandAloneBootStrapper.java:132)
[java] at org.jboss.soa.esb.listeners.StandAloneBootStrapper.(StandAloneBootStrapper.java:108)
[java] at org.jboss.soa.esb.listeners.StandAloneBootStrapper.main(StandAloneBootStrapper.java:77)
[java] Caused by: javax.jms.JMSException: There is no administratively defined queue with name:queue/quickstart_Aggregator_Request_GW
[java] at org.jboss.jms.server.endpoint.ServerSessionEndpoint.createQueue(ServerSessionEndpoint.java:255)
[java] at org.jboss.jms.server.endpoint.advised.SessionAdvised.org$jboss$jms$server$endpoint$advised$SessionAdvised$createQueue$aop(SessionAdvised.java:98)
[java] at org.jboss.jms.server.endpoint.advised.SessionAdvised$createQueue_6431069199924553036.invokeNext(SessionAdvised$createQueue_6431069199924553036.java)
[java] at org.jboss.jms.server.container.ServerLogInterceptor.invoke(ServerLogInterceptor.java:105)
[java] at org.jboss.jms.server.endpoint.advised.SessionAdvised$createQueue_6431069199924553036.invokeNext(SessionAdvised$createQueue_6431069199924553036.java)
[java] at org.jboss.jms.server.endpoint.advised.SessionAdvised.createQueue(SessionAdvised.java)
[java] at org.jboss.jms.wireformat.SessionCreateQueueRequest.serverInvoke(SessionCreateQueueRequest.java:74)
[java] at org.jboss.jms.server.remoting.JMSServerInvocationHandler.invoke(JMSServerInvocationHandler.java:125)
[java] at org.jboss.remoting.ServerInvoker.invoke(ServerInvoker.java:734)
[java] at org.jboss.remoting.transport.socket.ServerThread.processInvocation(ServerThread.java:553)
[java] at org.jboss.remoting.transport.socket.ServerThread.dorun(ServerThread.java:377)
[java] at org.jboss.remoting.transport.socket.ServerThread.run(ServerThread.java:159)
[java] at org.jboss.remoting.MicroRemoteClientInvoker.invoke(MicroRemoteClientInvoker.java:163)
[java] at org.jboss.remoting.Client.invoke(Client.java:1544)
[java] at org.jboss.remoting.Client.invoke(Client.java:530)
[java] at org.jboss.remoting.Client.invoke(Client.java:518)
[java] at org.jboss.jms.client.delegate.DelegateSupport.doInvoke(DelegateSupport.java:184)
[java] at org.jboss.jms.client.delegate.DelegateSupport.doInvoke(DelegateSupport.java:155)
[java] at org.jboss.jms.client.delegate.ClientSessionDelegate.org$jboss$jms$client$delegate$ClientSessionDelegate$createQueue$aop(ClientSessionDelegate.java:282)
[java] at org.jboss.jms.client.delegate.ClientSessionDelegate$createQueue_6431069199924553036.invokeNext(ClientSessionDelegate$createQueue_6431069199924553036.java)
[java] at org.jboss.jms.client.container.FailoverValveInterceptor.invoke(FailoverValveInterceptor.java:91)
[java] at org.jboss.aop.advice.PerInstanceInterceptor.invoke(PerInstanceInterceptor.java:105)
[java] at org.jboss.jms.client.delegate.ClientSessionDelegate$createQueue_6431069199924553036.invokeNext(ClientSessionDelegate$createQueue_6431069199924553036.java)
[java] at org.jboss.jms.client.container.ClosedInterceptor.invoke(ClosedInterceptor.java:171)
[java] at org.jboss.aop.advice.PerInstanceInterceptor.invoke(PerInstanceInterceptor.java:105)
[java] at org.jboss.jms.client.delegate.ClientSessionDelegate$createQueue_6431069199924553036.invokeNext(ClientSessionDelegate$createQueue_6431069199924553036.java)
[java] at org.jboss.jms.client.container.ExceptionInterceptor.invoke(ExceptionInterceptor.java:71)
[java] at org.jboss.jms.client.delegate.ClientSessionDelegate$createQueue_6431069199924553036.invokeNext(ClientSessionDelegate$createQueue_6431069199924553036.java)
[java] at org.jboss.jms.client.container.ClientLogInterceptor.invoke(ClientLogInterceptor.java:107)
[java] at org.jboss.jms.client.delegate.ClientSessionDelegate$createQueue_6431069199924553036.invokeNext(ClientSessionDelegate$createQueue_6431069199924553036.java)
[java] at org.jboss.jms.client.delegate.ClientSessionDelegate.createQueue(ClientSessionDelegate.java)
[java] at org.jboss.jms.client.JBossSession.createQueue(JBossSession.java:250)
[java] at org.jboss.soa.esb.listeners.gateway.JmsGatewayListener.prepareMessageReceiver(JmsGatewayListener.java:351)
[java] at org.jboss.soa.esb.listeners.gateway.JmsGatewayListener.doInitialise(JmsGatewayListener.java:105)
[java] ... 9 more
Bugger, didn't follow the instructions and forgot to manually deploy the JMS queues. The error message you get on the client side just doesn't tell you anything. The JBoss AS log contains the actual error message:
00:15:39,553 ERROR [ExceptionUtil] SessionEndpoint[65] createQueue [3j011-7f5o5a-f1grr3dp-1-f1gv3map-1j]
javax.jms.JMSException: There is no administratively defined queue with name:queue/quickstart_Aggregator_Request_GW
at org.jboss.jms.server.endpoint.ServerSessionEndpoint.createQueue(ServerSessionEndpoint.java:255)
at org.jboss.jms.server.endpoint.advised.SessionAdvised.org$jboss$jms$server$endpoint$advised$SessionAdvised$createQueue$aop(SessionAdvised.java:98)
at org.jboss.jms.server.endpoint.advised.SessionAdvised$createQueue_6431069199924553036.invokeNext(SessionAdvised$createQueue_6431069199924553036.java)
at org.jboss.jms.server.container.ServerLogInterceptor.invoke(ServerLogInterceptor.java:105)
at org.jboss.jms.server.endpoint.advised.SessionAdvised$createQueue_6431069199924553036.invokeNext(SessionAdvised$createQueue_6431069199924553036.java)
at org.jboss.jms.server.endpoint.advised.SessionAdvised.createQueue(SessionAdvised.java)
at org.jboss.jms.wireformat.SessionCreateQueueRequest.serverInvoke(SessionCreateQueueRequest.java:74)
at org.jboss.jms.server.remoting.JMSServerInvocationHandler.invoke(JMSServerInvocationHandler.java:125)
at org.jboss.remoting.ServerInvoker.invoke(ServerInvoker.java:734)
at org.jboss.remoting.transport.socket.ServerThread.processInvocation(ServerThread.java:553)
at org.jboss.remoting.transport.socket.ServerThread.dorun(ServerThread.java:377)
at org.jboss.remoting.transport.socket.ServerThread.run(ServerThread.java:159)
So, let deploy the JMS stuff before moving on.
1. In a command terminal window in the quickstart folder type 'ant deploy-jms-dests'
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant deploy-jms-dests
Buildfile: build.xml
deploy-jms-dests:
[copy] Copying 1 file to /home/jarkko/esb42MR2/esb-server/server/default/deploy
BUILD SUCCESSFUL
Total time: 0 seconds
And suddenly you get horde of JMS destinations and queues up and running.
0:19:43,879 INFO [QueueService] Queue[/queue/quickstart_helloworld_Request] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,884 INFO [QueueService] Queue[/queue/quickstart_helloworld_Request_gw] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,890 INFO [QueueService] Queue[/queue/quickstart_helloworld_Request_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,896 INFO [QueueService] Queue[/queue/quickstart_helloworld_action_Request] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,903 INFO [QueueService] Queue[/queue/quickstart_helloworld_action_Response] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,908 INFO [QueueService] Queue[/queue/quickstart_helloworld_db_registration] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,913 INFO [QueueService] Queue[/queue/quickstart_helloworld_file_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,919 INFO [QueueService] Queue[/queue/quickstart_helloworld_ftp_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,924 INFO [QueueService] Queue[/queue/quickstart_scripting_groovy_gw] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,929 INFO [QueueService] Queue[/queue/quickstart_scripting_groovy_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,934 INFO [QueueService] Queue[/queue/quickstart_edi_groovy_xslt_gw] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,939 INFO [QueueService] Queue[/queue/quickstart_edi_groovy_xslt_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,944 INFO [QueueService] Queue[/queue/quickstart_transform_pojo_gw] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,950 INFO [QueueService] Queue[/queue/quickstart_transform_pojo_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,955 INFO [QueueService] Queue[/queue/quickstart_date_manipulation_gw] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,960 INFO [QueueService] Queue[/queue/quickstart_date_manipulation_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,965 INFO [QueueService] Queue[/queue/quickstart_transform_simple_gw] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,971 INFO [QueueService] Queue[/queue/quickstart_transform_simple_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,976 INFO [QueueService] Queue[/queue/quickstart_webservice_jbossws_adapter_01_gw] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,987 INFO [QueueService] Queue[/queue/quickstart_webservice_jbossws_adapter_01_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,992 INFO [QueueService] Queue[/queue/quickstart_webservice_jbossws_adapter_01_esb_reply] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:43,997 INFO [QueueService] Queue[/queue/quickstart_webservice_war1_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,001 INFO [QueueService] Queue[/queue/quickstart_webservice_war1_reply] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,006 INFO [QueueService] Queue[/queue/quickstart_simple_transformation_Request] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,010 INFO [QueueService] Queue[/queue/quickstart_simple_transformation_Response] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,019 INFO [QueueService] Queue[/queue/quickstart_simple_cbr_Request] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,024 INFO [QueueService] Queue[/queue/CBRExpressFreeShipping] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,029 INFO [QueueService] Queue[/queue/CBRNormalShipping] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,034 INFO [QueueService] Queue[/queue/CBRExpressFreeShippingAlert] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,039 INFO [QueueService] Queue[/queue/CBRNormalShippingAlert] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,045 INFO [QueueService] Queue[/queue/quickstart_more_action_Request] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,057 INFO [QueueService] Queue[/queue/quickstart_more_action_Response] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,062 INFO [QueueService] Queue[/queue/quickstart_Fun_CBR_Request_GW] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,067 INFO [QueueService] Queue[/queue/quickstart_Fun_CBR_Request_ESB] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,072 INFO [QueueService] Queue[/queue/quickstart_Fun_CBR_ToBlue] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,077 INFO [QueueService] Queue[/queue/quickstart_Fun_CBR_Blue_Alert] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,082 INFO [QueueService] Queue[/queue/quickstart_Fun_CBR_ToRed] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,088 INFO [QueueService] Queue[/queue/quickstart_Fun_CBR_Red_Alert] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,093 INFO [QueueService] Queue[/queue/quickstart_Fun_CBR_ToGreenTransformer] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,098 INFO [QueueService] Queue[/queue/quickstart_Fun_CBR_ToGreen] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,103 INFO [QueueService] Queue[/queue/quickstart_Fun_CBR_Green_Alert] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,107 INFO [QueueService] Queue[/queue/quickstart_Aggregator_Request_GW] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,112 INFO [QueueService] Queue[/queue/quickstart_Aggregator_Request_ESB] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,117 INFO [QueueService] Queue[/queue/quickstart_Aggregator_ToBlue] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,122 INFO [QueueService] Queue[/queue/quickstart_Aggregator_Blue_Alert] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,126 INFO [QueueService] Queue[/queue/quickstart_Aggregator_ToRed] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,131 INFO [QueueService] Queue[/queue/quickstart_Aggregator_Red_Alert] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,137 INFO [QueueService] Queue[/queue/quickstart_Aggregator_ToGreen] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,142 INFO [QueueService] Queue[/queue/quickstart_Aggregator_Green_Alert] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,147 INFO [QueueService] Queue[/queue/quickstart_transform_CSV2XML_gw] started, fullSize=200000, pageSize=2000, downCacheSize=2000
00:19:44,153 INFO [QueueService] Queue[/queue/quickstart_transform_CSV2XML_esb] started, fullSize=200000, pageSize=2000, downCacheSize=2000
Then I used screen to create some virtual terminals and started up rest tasks.
3. Command Window 1: "ant run" - contains the splitter. It will display the entire XML message to its console
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant run
Buildfile: build.xml
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
jar:
run:
[echo] Inbound Router/Splitter:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/inbound_splitter/jbossesb.xml
4. Command Window 2: "ant runRedService" - rips out just the Customer. It will display just the Customer information to its console.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runRedService
Buildfile: build.xml
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
runRedService:
[echo] Red Service:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/red_service/jbossesb.xml
5. Command Window 3: "ant runGreenService" - rips out just the LineItems. It will display just the LineItems to its console
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runGreenService
Buildfile: build.xml
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
runGreenService:
[echo] Green Service:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/green_service/jbossesb.xml
6. Command Window 4: "ant runBlueService" - rips out just the OrderHeader. It will display just the Order header information to its console.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runBlueService
Buildfile: build.xml
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
runBlueService:
[echo] Blue Service:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/blue_service/jbossesb.xml
7. Command Window 5: "ant runAggregatorService" - displays the parts together. It will simply push out the individual message parts. More details on how that is achieved can be found below.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runAggregatorService
Buildfile: build.xml8. Command Window 6: "ant runtest" - this sends the SampleOrder.xml into the splitter's queue
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
runAggregatorService:
[echo] Aggregator Service:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/aggregation_service/jbossesb.xml
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant runtest
Buildfile: build.xmlSomething appeared to JBoss AS log, even though the test seemed to run ok.
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
runtest:
[echo] Runs Test JMS Sender
[java] Connection Started
[java] ---------------------------------------------
[java]
[java]
[java]
[java]
[java]
[java]
[java]
[java]
[java]
[java]
[java]
[java] ---------------------------------------------
BUILD SUCCESSFUL
Total time: 2 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$
00:28:54,602 ERROR [AbstractService] E_busy (10400) The request cannot be processed at the current time. The Registry is currently unavailable.ant run -window contained some more errors
[java] Caused by: java.rmi.RemoteException: faultCode=Server, faultString=E_busy (10400) The request cannot be processed at the current time. The Registry is currently unavailable., faultActor=null, errno=10400, errCode=E_busy, errText=E_busy (10400) The request cannot be processed at the current time. The Registry is currently unavailable.; nested exception is:
[java] java.lang.Exception: faultCode=Server, faultString=E_busy (10400) The request cannot be processed at the current time. The Registry is currently unavailable., faultActor=null, errno=10400, errCode=E_busy, errText=E_busy (10400) The request cannot be processed at the current time. The Registry is currently unavailable.
[java] at org.apache.juddi.registry.rmi.InquiryService.inquire(InquiryService.java:26)
[java] at sun.reflect.GeneratedMethodAccessor98.invoke(Unknown Source)
[java] at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
[java] at java.lang.reflect.Method.invoke(Method.java:597)
[java] at sun.rmi.server.UnicastServerRef.dispatch(UnicastServerRef.java:305)
[java] at sun.rmi.transport.Transport$1.run(Transport.java:159)
[java] at java.security.AccessController.doPrivileged(Native Method)
[java] at sun.rmi.transport.Transport.serviceCall(Transport.java:155)
[java] at sun.rmi.transport.tcp.TCPTransport.handleMessages(TCPTransport.java:535)
[java] at sun.rmi.transport.tcp.TCPTransport$ConnectionHandler.run0(TCPTransport.java:790)
[java] at sun.rmi.transport.tcp.TCPTransport$ConnectionHandler.run(TCPTransport.java:649)
[java] ... 3 more
[java] Caused by: java.lang.Exception: faultCode=Server, faultString=E_busy (10400) The request cannot be processed at the current time. The Registry is currently unavailable., faultActor=null, errno=10400, errCode=E_busy, errText=E_busy (10400) The request cannot be processed at the current time. The Registry is currently unavailable.
[java] at org.apache.juddi.registry.local.AbstractService.handleRequest(AbstractService.java:269)
[java] at org.apache.juddi.registry.local.InquiryService.inquire(InquiryService.java:77)
[java] at org.apache.juddi.registry.rmi.InquiryService.inquire(InquiryService.java:24)
[java] ... 13 more
However, RGB services seems to be working just fine. First the red service window.
runRedService:
[echo] Red Service:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/red_service/jbossesb.xml
[java] &&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&
[java] Customer: Fletcher,Harry,user1
[java] &&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&
Then green,
runGreenService:
[echo] Green Service:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/green_service/jbossesb.xml
[java] &&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&
[java] Order Items (2):
[java] 0: 1,1,364,The 40-Year-Old Virgin ,29.98
[java] 1: 2,1,299,Pulp Fiction,29.99
[java] &&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&
And Blue,
runBlueService:
[echo] Blue Service:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/blue_service/jbossesb.xml
[java] &&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&
[java] 1, Wed Nov 15 13:45:28 EST 2006, 0, 59.97, 64.92, 4.95,
[java] &&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&&
And finally, the aggreate service window
runAggregatorService:But something seems to be broken, because running "ant test" again has no effects in any of the RGB/Aggregator windows, so only one JMS got through the ESB. Only a small error message in the JBoss AS log shows that something went broke.
[echo] Aggregator Service:
[java] +----------------------------------------------------------+
[java] | |
[java] | Starting JBossESB... |
[java] | |
[java] +----------------------------------------------------------+
[java] Reading config from /home/jarkko/esb42MR2/esb/samples/quickstarts/aggregator/aggregation_service/jbossesb.xml
[java] An aggregated message was created:
[java] attachment 0: [Customer: Fletcher,Harry,user1].
[java] attachment 1: [1, Wed Nov 15 13:45:28 EST 2006, 0, 59.97, 64.92, 4.95, ].
[java] attachment 2: [Order Items (2):
[java] 0: 1,1,364,The 40-Year-Old Virgin ,29.98
[java] 1: 2,1,299,Pulp Fiction,29.99].
00:31:14,809 WARN [SimpleConnectionManager] ConnectionManager[284f2189] cannot look up remoting session ID 3j011-h2cls6-f1gve80a-1-f1gve8cc-4
00:31:14,809 WARN [SimpleConnectionManager] A problem has been detected with the connection to remote client 3j011-h2cls6-f1gve80a-1-f1gve8cc-4. It is possible the client has exited without closing its connection(s) or there is a network problem. All connection resources corresponding to that client process will now be removed.
So finish up testing using the very convenient ant task to undeploy any installed JMS destinations and queues.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/aggregator$ ant undeploy-jms-dests
Buildfile: build.xml
undeploy-jms-dests:
[delete] Deleting: /home/jarkko/esb42MR2/esb-server/server/default/deploy/esb-quickstart-jbm-service.xml
BUILD SUCCESSFUL
Total time: 0 seconds
bpm_orchestration1
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
clean:
Overriding previous definition of reference to quickstart-dependencies-classpath
quickstart-specific-clean:
[echo] No Quickstart specific 'clean' being made.
prepare:
BUILD FAILED
/home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build.xml:26: /home/jarkko/esb42MR2/esb/build/jbossesb/lib/jbpm.esb not found.
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$
build.xml has some wrong paths:
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ diff -u build.xml.orig build.xml
--- build.xml.orig 2007-05-09 17:07:46.661004119 +0300
+++ build.xml 2007-05-09 17:08:06.578139132 +0300
@@ -9,7 +9,7 @@
<import file="../conf/base-build.xml"/>
<!--property name="jbpm.services.build.dir" value="${product.dir}/build/services/jbpm.esb" /-->
- <property name="jbpm.services.build.dir" value="${product.dir}/build/services/jbpm.esb" />
+ <property name="jbpm.services.build.dir" value="${product.dir}/lib/jbpm.esb" />
<property name="jbossesb.inputdir" location="/tmp"/>
<property name="project.process.dir" value="processDefinition1"/>
Ok, now we can move one building and deploying the example.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant deploy
And output from JBoss AS log:
Then try to run the test, but alas, there's no such target runtest in the build.xml:
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant runtest
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
BUILD FAILED
Target `runtest' does not exist in this project.
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$
From build.xml I found couple interesting tasks, deployProcess and startProcess, lest run the first one first.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant startProcess
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
startProcess:
[echo] Sends a message to start the process instance
[java] Here
BUILD SUCCESSFUL
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant deployProcess
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
deployProcess:
[echo] Sends a message to deploy the process definition
[java] Here
BUILD SUCCESSFUL
Total time: 1 second
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$
And again there's a lot of output from JBoss AS log:
17:25:04,853 INFO [MessageSpy] Body: Start It Up
17:25:04,990 INFO [Environment] Hibernate 3.2.1
17:25:04,998 INFO [Environment] hibernate.properties not found
17:25:05,001 INFO [Environment] Bytecode provider name : cglib
17:25:05,006 INFO [Environment] using JDK 1.4 java.sql.Timestamp handling
17:25:05,081 INFO [Configuration] configuring from resource: hibernate.cfg.xml
17:25:05,081 INFO [Configuration] Configuration resource: hibernate.cfg.xml
17:25:05,105 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/action/Script.hbm.xml
17:25:05,181 INFO [Configuration] Reading mappings from resource : org/jbpm/identity/User.hbm.xml
17:25:05,212 INFO [HbmBinder] Mapping class: org.jbpm.identity.User -> JBPM_ID_USER
17:25:05,246 INFO [HbmBinder] Mapping collection: org.jbpm.identity.User.permissions -> JBPM_ID_PERMISSIONS
17:25:05,246 INFO [Configuration] Reading mappings from resource : org/jbpm/identity/Group.hbm.xml
17:25:05,287 INFO [HbmBinder] Mapping class: org.jbpm.identity.Group -> JBPM_ID_GROUP
17:25:05,408 INFO [HbmBinder] Mapping collection: org.jbpm.identity.Group.permissions -> JBPM_ID_PERMISSIONS
17:25:05,409 INFO [Configuration] Reading mappings from resource : org/jbpm/identity/Membership.hbm.xml
17:25:05,425 INFO [HbmBinder] Mapping class: org.jbpm.identity.Membership -> JBPM_ID_MEMBERSHIP
17:25:05,426 INFO [HbmBinder] Mapping collection: org.jbpm.identity.Membership.permissions -> JBPM_ID_PERMISSIONS
17:25:05,427 INFO [Configuration] Reading mappings from resource : org/jbpm/db/hibernate.queries.hbm.xml
17:25:05,521 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/ProcessDefinition.hbm.xml
17:25:05,539 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.ProcessDefinition -> JBPM_PROCESSDEFINITION
17:25:05,550 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/Node.hbm.xml
17:25:05,751 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.Node -> JBPM_NODE
17:25:05,767 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/Transition.hbm.xml
17:25:05,861 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.Transition -> JBPM_TRANSITION
17:25:05,862 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/Event.hbm.xml
17:25:05,929 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.Event -> JBPM_EVENT
17:25:05,930 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/Action.hbm.xml
17:25:05,942 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.Action -> JBPM_ACTION
17:25:05,944 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/SuperState.hbm.xml
17:25:05,986 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.def.SuperState -> JBPM_NODE
17:25:05,986 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/ExceptionHandler.hbm.xml
17:25:06,121 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.ExceptionHandler -> JBPM_EXCEPTIONHANDLER
17:25:06,122 INFO [Configuration] Reading mappings from resource : org/jbpm/instantiation/Delegation.hbm.xml
17:25:06,135 INFO [HbmBinder] Mapping class: org.jbpm.instantiation.Delegation -> JBPM_DELEGATION
17:25:06,136 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/StartState.hbm.xml
17:25:06,193 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.StartState -> JBPM_NODE
17:25:06,194 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/EndState.hbm.xml
17:25:06,202 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.EndState -> JBPM_NODE
17:25:06,203 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/ProcessState.hbm.xml
17:25:06,216 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.ProcessState -> JBPM_NODE
17:25:06,219 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/Decision.hbm.xml
17:25:06,634 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.Decision -> JBPM_NODE
17:25:06,636 INFO [HbmBinder] Mapping collection: org.jbpm.graph.node.Decision.decisionConditions -> JBPM_DECISIONCONDITIONS
17:25:06,636 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/Fork.hbm.xml
17:25:06,642 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.Fork -> JBPM_NODE
17:25:06,643 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/Join.hbm.xml
17:25:06,648 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.Join -> JBPM_NODE
17:25:06,649 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/State.hbm.xml
17:25:06,659 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.State -> JBPM_NODE
17:25:06,659 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/TaskNode.hbm.xml
17:25:06,670 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.TaskNode -> JBPM_NODE
17:25:06,671 INFO [Configuration] Reading mappings from resource : org/jbpm/context/def/ContextDefinition.hbm.xml
17:25:06,677 INFO [Configuration] Reading mappings from resource : org/jbpm/context/def/VariableAccess.hbm.xml
17:25:06,683 INFO [HbmBinder] Mapping class: org.jbpm.context.def.VariableAccess -> JBPM_VARIABLEACCESS
17:25:06,686 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/def/TaskMgmtDefinition.hbm.xml
17:25:06,692 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/def/Swimlane.hbm.xml
17:25:06,698 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.def.Swimlane -> JBPM_SWIMLANE
17:25:06,700 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/def/Task.hbm.xml
17:25:06,712 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.def.Task -> JBPM_TASK
17:25:06,717 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/def/TaskController.hbm.xml
17:25:06,723 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.def.TaskController -> JBPM_TASKCONTROLLER
17:25:06,725 INFO [Configuration] Reading mappings from resource : org/jbpm/module/def/ModuleDefinition.hbm.xml
17:25:06,731 INFO [HbmBinder] Mapping class: org.jbpm.module.def.ModuleDefinition -> JBPM_MODULEDEFINITION
17:25:06,732 INFO [Configuration] Reading mappings from resource : org/jbpm/bytes/ByteArray.hbm.xml
17:25:06,738 INFO [HbmBinder] Mapping class: org.jbpm.bytes.ByteArray -> JBPM_BYTEARRAY
17:25:06,740 INFO [HbmBinder] Mapping collection: org.jbpm.bytes.ByteArray.byteBlocks -> JBPM_BYTEBLOCK
17:25:06,740 INFO [Configuration] Reading mappings from resource : org/jbpm/file/def/FileDefinition.hbm.xml
17:25:06,745 INFO [HbmBinder] Mapping subclass: org.jbpm.file.def.FileDefinition -> JBPM_MODULEDEFINITION
17:25:06,746 INFO [Configuration] Reading mappings from resource : org/jbpm/scheduler/def/CreateTimerAction.hbm.xml
17:25:06,751 INFO [HbmBinder] Mapping subclass: org.jbpm.scheduler.def.CreateTimerAction -> JBPM_ACTION
17:25:06,753 INFO [Configuration] Reading mappings from resource : org/jbpm/scheduler/def/CancelTimerAction.hbm.xml
17:25:06,759 INFO [HbmBinder] Mapping subclass: org.jbpm.scheduler.def.CancelTimerAction -> JBPM_ACTION
17:25:06,759 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/exe/Comment.hbm.xml
17:25:06,766 INFO [HbmBinder] Mapping class: org.jbpm.graph.exe.Comment -> JBPM_COMMENT
17:25:06,768 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/exe/ProcessInstance.hbm.xml
17:25:06,794 INFO [HbmBinder] Mapping class: org.jbpm.graph.exe.ProcessInstance -> JBPM_PROCESSINSTANCE
17:25:06,800 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/exe/Token.hbm.xml
17:25:06,807 INFO [HbmBinder] Mapping class: org.jbpm.graph.exe.Token -> JBPM_TOKEN
17:25:06,813 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/exe/RuntimeAction.hbm.xml
17:25:06,820 INFO [HbmBinder] Mapping class: org.jbpm.graph.exe.RuntimeAction -> JBPM_RUNTIMEACTION
17:25:06,821 INFO [Configuration] Reading mappings from resource : org/jbpm/module/exe/ModuleInstance.hbm.xml
17:25:06,826 INFO [HbmBinder] Mapping class: org.jbpm.module.exe.ModuleInstance -> JBPM_MODULEINSTANCE
17:25:06,827 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/ContextInstance.hbm.xml
17:25:06,833 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.ContextInstance -> JBPM_MODULEINSTANCE
17:25:06,833 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/TokenVariableMap.hbm.xml
17:25:06,839 INFO [HbmBinder] Mapping class: org.jbpm.context.exe.TokenVariableMap -> JBPM_TOKENVARIABLEMAP
17:25:06,843 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/VariableInstance.hbm.xml
17:25:06,849 INFO [HbmBinder] Mapping class: org.jbpm.context.exe.VariableInstance -> JBPM_VARIABLEINSTANCE
17:25:06,853 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/ByteArrayInstance.hbm.xml
17:25:06,858 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.ByteArrayInstance -> JBPM_VARIABLEINSTANCE
17:25:06,858 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/DateInstance.hbm.xml
17:25:06,867 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.DateInstance -> JBPM_VARIABLEINSTANCE
17:25:06,867 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/DoubleInstance.hbm.xml
17:25:06,872 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.DoubleInstance -> JBPM_VARIABLEINSTANCE
17:25:06,873 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/HibernateLongInstance.hbm.xml
17:25:06,878 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.HibernateLongInstance -> JBPM_VARIABLEINSTANCE
17:25:06,878 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/HibernateStringInstance.hbm.xml
17:25:06,886 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.HibernateStringInstance -> JBPM_VARIABLEINSTANCE
17:25:06,886 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/LongInstance.hbm.xml
17:25:06,891 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.LongInstance -> JBPM_VARIABLEINSTANCE
17:25:06,892 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/NullInstance.hbm.xml
17:25:06,896 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.NullInstance -> JBPM_VARIABLEINSTANCE
17:25:06,896 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/StringInstance.hbm.xml
17:25:06,901 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.StringInstance -> JBPM_VARIABLEINSTANCE
17:25:06,901 INFO [Configuration] Reading mappings from resource : org/jbpm/job/Job.hbm.xml
17:25:06,907 INFO [HbmBinder] Mapping class: org.jbpm.job.Job -> JBPM_JOB
17:25:06,909 INFO [Configuration] Reading mappings from resource : org/jbpm/job/Timer.hbm.xml
17:25:06,915 INFO [HbmBinder] Mapping subclass: org.jbpm.job.Timer -> JBPM_JOB
17:25:06,917 INFO [Configuration] Reading mappings from resource : org/jbpm/job/ExecuteNodeJob.hbm.xml
17:25:06,922 INFO [HbmBinder] Mapping subclass: org.jbpm.job.ExecuteNodeJob -> JBPM_JOB
17:25:06,923 INFO [Configuration] Reading mappings from resource : org/jbpm/job/ExecuteActionJob.hbm.xml
17:25:06,927 INFO [HbmBinder] Mapping subclass: org.jbpm.job.ExecuteActionJob -> JBPM_JOB
17:25:06,928 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/exe/TaskMgmtInstance.hbm.xml
17:25:06,954 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.exe.TaskMgmtInstance -> JBPM_MODULEINSTANCE
17:25:06,958 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/exe/TaskInstance.hbm.xml
17:25:07,030 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.exe.TaskInstance -> JBPM_TASKINSTANCE
17:25:07,036 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskInstance.pooledActors -> JBPM_TASKACTORPOOL
17:25:07,037 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/exe/PooledActor.hbm.xml
17:25:07,042 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.exe.PooledActor -> JBPM_POOLEDACTOR
17:25:07,044 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.PooledActor.taskInstances -> JBPM_TASKACTORPOOL
17:25:07,044 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/exe/SwimlaneInstance.hbm.xml
17:25:07,050 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.exe.SwimlaneInstance -> JBPM_SWIMLANEINSTANCE
17:25:07,051 INFO [Configuration] Reading mappings from resource : org/jbpm/logging/log/ProcessLog.hbm.xml
17:25:07,056 INFO [HbmBinder] Mapping class: org.jbpm.logging.log.ProcessLog -> JBPM_LOG
17:25:07,057 INFO [Configuration] Reading mappings from resource : org/jbpm/logging/log/MessageLog.hbm.xml
17:25:07,062 INFO [HbmBinder] Mapping subclass: org.jbpm.logging.log.MessageLog -> JBPM_LOG
17:25:07,062 INFO [Configuration] Reading mappings from resource : org/jbpm/logging/log/CompositeLog.hbm.xml
17:25:07,067 INFO [HbmBinder] Mapping subclass: org.jbpm.logging.log.CompositeLog -> JBPM_LOG
17:25:07,067 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/ActionLog.hbm.xml
17:25:07,072 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.ActionLog -> JBPM_LOG
17:25:07,072 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/NodeLog.hbm.xml
17:25:07,077 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.NodeLog -> JBPM_LOG
17:25:07,078 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/ProcessInstanceCreateLog.hbm.xml
17:25:07,083 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.ProcessInstanceCreateLog -> JBPM_LOG
17:25:07,083 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/ProcessInstanceEndLog.hbm.xml
17:25:07,087 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.ProcessInstanceEndLog -> JBPM_LOG
17:25:07,088 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/ProcessStateLog.hbm.xml
17:25:07,092 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.ProcessStateLog -> JBPM_LOG
17:25:07,093 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/SignalLog.hbm.xml
17:25:07,097 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.SignalLog -> JBPM_LOG
17:25:07,098 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/TokenCreateLog.hbm.xml
17:25:07,102 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.TokenCreateLog -> JBPM_LOG
17:25:07,102 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/TokenEndLog.hbm.xml
17:25:07,110 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.TokenEndLog -> JBPM_LOG
17:25:07,111 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/TransitionLog.hbm.xml
17:25:07,116 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.TransitionLog -> JBPM_LOG
17:25:07,116 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/VariableLog.hbm.xml
17:25:07,139 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.VariableLog -> JBPM_LOG
17:25:07,139 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/VariableCreateLog.hbm.xml
17:25:07,146 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.VariableCreateLog -> JBPM_LOG
17:25:07,146 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/VariableDeleteLog.hbm.xml
17:25:07,150 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.VariableDeleteLog -> JBPM_LOG
17:25:07,151 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/VariableUpdateLog.hbm.xml
17:25:07,155 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.VariableUpdateLog -> JBPM_LOG
17:25:07,155 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/ByteArrayUpdateLog.hbm.xml
17:25:07,160 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.ByteArrayUpdateLog -> JBPM_LOG
17:25:07,160 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/DateUpdateLog.hbm.xml
17:25:07,164 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.DateUpdateLog -> JBPM_LOG
17:25:07,165 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/DoubleUpdateLog.hbm.xml
17:25:07,170 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.DoubleUpdateLog -> JBPM_LOG
17:25:07,170 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/HibernateLongUpdateLog.hbm.xml
17:25:07,175 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.HibernateLongUpdateLog -> JBPM_LOG
17:25:07,175 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/HibernateStringUpdateLog.hbm.xml
17:25:07,180 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.HibernateStringUpdateLog -> JBPM_LOG
17:25:07,180 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/LongUpdateLog.hbm.xml
17:25:07,185 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.LongUpdateLog -> JBPM_LOG
17:25:07,185 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/StringUpdateLog.hbm.xml
17:25:07,189 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.StringUpdateLog -> JBPM_LOG
17:25:07,190 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/TaskLog.hbm.xml
17:25:07,195 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.TaskLog -> JBPM_LOG
17:25:07,195 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/TaskCreateLog.hbm.xml
17:25:07,199 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.TaskCreateLog -> JBPM_LOG
17:25:07,200 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/TaskAssignLog.hbm.xml
17:25:07,204 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.TaskAssignLog -> JBPM_LOG
17:25:07,205 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/TaskEndLog.hbm.xml
17:25:07,209 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.TaskEndLog -> JBPM_LOG
17:25:07,210 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/SwimlaneLog.hbm.xml
17:25:07,218 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.SwimlaneLog -> JBPM_LOG
17:25:07,218 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/SwimlaneCreateLog.hbm.xml
17:25:07,223 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.SwimlaneCreateLog -> JBPM_LOG
17:25:07,225 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/SwimlaneAssignLog.hbm.xml
17:25:07,229 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.SwimlaneAssignLog -> JBPM_LOG
17:25:07,231 INFO [Configuration] Configured SessionFactory: null
17:25:07,231 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.action.Script -> JBPM_ACTION
17:25:07,234 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.def.TaskMgmtDefinition -> JBPM_MODULEDEFINITION
17:25:07,234 INFO [HbmBinder] Mapping subclass: org.jbpm.context.def.ContextDefinition -> JBPM_MODULEDEFINITION
17:25:07,235 INFO [HbmBinder] Mapping collection: org.jbpm.identity.User.memberships -> JBPM_ID_MEMBERSHIP
17:25:07,236 INFO [HbmBinder] Mapping collection: org.jbpm.identity.Group.children -> JBPM_ID_GROUP
17:25:07,236 INFO [HbmBinder] Mapping collection: org.jbpm.identity.Group.memberships -> JBPM_ID_MEMBERSHIP
17:25:07,236 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.events -> JBPM_EVENT
17:25:07,237 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.exceptionHandlers -> JBPM_EXCEPTIONHANDLER
17:25:07,237 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.nodes -> JBPM_NODE
17:25:07,237 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.actions -> JBPM_ACTION
17:25:07,238 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.definitions -> JBPM_MODULEDEFINITION
17:25:07,238 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Node.events -> JBPM_EVENT
17:25:07,238 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Node.exceptionHandlers -> JBPM_EXCEPTIONHANDLER
17:25:07,238 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Node.leavingTransitions -> JBPM_TRANSITION
17:25:07,239 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Node.arrivingTransitions -> JBPM_TRANSITION
17:25:07,239 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Transition.events -> JBPM_EVENT
17:25:07,239 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Transition.exceptionHandlers -> JBPM_EXCEPTIONHANDLER
17:25:07,239 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Event.actions -> JBPM_ACTION
17:25:07,240 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.SuperState.nodes -> JBPM_NODE
17:25:07,240 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ExceptionHandler.actions -> JBPM_ACTION
17:25:07,240 INFO [HbmBinder] Mapping collection: org.jbpm.graph.node.ProcessState.variableAccesses -> JBPM_VARIABLEACCESS
17:25:07,249 INFO [HbmBinder] Mapping collection: org.jbpm.graph.node.TaskNode.tasks -> JBPM_TASK
17:25:07,249 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.Swimlane.tasks -> JBPM_TASK
17:25:07,249 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.Task.events -> JBPM_EVENT
17:25:07,249 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.Task.exceptionHandlers -> JBPM_EXCEPTIONHANDLER
17:25:07,250 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.TaskController.variableAccesses -> JBPM_VARIABLEACCESS
17:25:07,250 INFO [HbmBinder] Mapping collection: org.jbpm.file.def.FileDefinition.processFiles -> JBPM_BYTEARRAY
17:25:07,250 INFO [HbmBinder] Mapping collection: org.jbpm.graph.exe.ProcessInstance.runtimeActions -> JBPM_RUNTIMEACTION
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.graph.exe.ProcessInstance.instances -> JBPM_MODULEINSTANCE
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.graph.exe.Token.children -> JBPM_TOKEN
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.graph.exe.Token.comments -> JBPM_COMMENT
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.context.exe.ContextInstance.tokenVariableMaps -> JBPM_TOKENVARIABLEMAP
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.context.exe.TokenVariableMap.variableInstances -> JBPM_VARIABLEINSTANCE
17:25:07,252 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskMgmtInstance.swimlaneInstances -> JBPM_SWIMLANEINSTANCE
17:25:07,252 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskMgmtInstance.taskInstances -> JBPM_TASKINSTANCE
17:25:07,252 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskInstance.variableInstances -> JBPM_VARIABLEINSTANCE
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskInstance.comments -> JBPM_COMMENT
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.SwimlaneInstance.pooledActors -> JBPM_POOLEDACTOR
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.logging.log.CompositeLog.children -> JBPM_LOG
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.graph.action.Script.variableAccesses -> JBPM_VARIABLEACCESS
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.TaskMgmtDefinition.swimlanes -> JBPM_SWIMLANE
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.TaskMgmtDefinition.tasks -> JBPM_TASK
17:25:07,306 INFO [DriverManagerConnectionProvider] Using Hibernate built-in connection pool (not for production use!)
17:25:07,306 INFO [DriverManagerConnectionProvider] Hibernate connection pool size: 20
17:25:07,306 INFO [DriverManagerConnectionProvider] autocommit mode: false
17:25:07,306 INFO [DriverManagerConnectionProvider] using driver: org.hsqldb.jdbcDriver at URL: jdbc:hsqldb:mem:jbpm
17:25:07,306 INFO [DriverManagerConnectionProvider] connection properties: {user=sa, password=}
17:25:07,314 INFO [SettingsFactory] RDBMS: HSQL Database Engine, version: 1.8.0
17:25:07,314 INFO [SettingsFactory] JDBC driver: HSQL Database Engine Driver, version: 1.8.0
17:25:07,331 INFO [Dialect] Using dialect: org.hibernate.dialect.HSQLDialect
17:25:07,337 INFO [TransactionFactoryFactory] Using default transaction strategy (direct JDBC transactions)
17:25:07,339 INFO [TransactionManagerLookupFactory] No TransactionManagerLookup configured (in JTA environment, use of read-write or transactional second-level cache is not recommended)
17:25:07,339 INFO [SettingsFactory] Automatic flush during beforeCompletion(): disabled
17:25:07,339 INFO [SettingsFactory] Automatic session close at end of transaction: disabled
17:25:07,339 INFO [SettingsFactory] JDBC batch size: 15
17:25:07,339 INFO [SettingsFactory] JDBC batch updates for versioned data: disabled
17:25:07,340 INFO [SettingsFactory] Scrollable result sets: enabled
17:25:07,340 INFO [SettingsFactory] JDBC3 getGeneratedKeys(): disabled
17:25:07,340 INFO [SettingsFactory] Connection release mode: auto
17:25:07,341 INFO [SettingsFactory] Default batch fetch size: 1
17:25:07,341 INFO [SettingsFactory] Generate SQL with comments: disabled
17:25:07,341 INFO [SettingsFactory] Order SQL updates by primary key: disabled
17:25:07,341 INFO [SettingsFactory] Query translator: org.hibernate.hql.ast.ASTQueryTranslatorFactory
17:25:07,343 INFO [ASTQueryTranslatorFactory] Using ASTQueryTranslatorFactory
17:25:07,343 INFO [SettingsFactory] Query language substitutions: {}
17:25:07,343 INFO [SettingsFactory] JPA-QL strict compliance: disabled
17:25:07,343 INFO [SettingsFactory] Second-level cache: enabled
17:25:07,343 INFO [SettingsFactory] Query cache: disabled
17:25:07,344 INFO [SettingsFactory] Cache provider: org.hibernate.cache.HashtableCacheProvider
17:25:07,345 INFO [SettingsFactory] Optimize cache for minimal puts: disabled
17:25:07,345 INFO [SettingsFactory] Structured second-level cache entries: disabled
17:25:07,350 INFO [SettingsFactory] Statistics: disabled
17:25:07,350 INFO [SettingsFactory] Deleted entity synthetic identifier rollback: disabled
17:25:07,350 INFO [SettingsFactory] Default entity-mode: pojo
17:25:07,375 INFO [SessionFactoryImpl] building session factory
17:25:08,681 INFO [SessionFactoryObjectFactory] Not binding factory to JNDI, no JNDI name configured
17:25:08,697 INFO [SchemaExport] Running hbm2ddl schema export
17:25:08,699 INFO [SchemaExport] exporting generated schema to database
17:25:08,738 INFO [SchemaExport] schema export complete
17:25:09,471 INFO [ProcessInfo] Token ID: null
17:25:09,471 INFO [ProcessInfo] Process Name: null
17:25:09,471 INFO [ProcessInfo] Process Version: null
17:25:09,471 INFO [MessageSpy] Body Contents are NULL
17:25:09,472 ERROR [STDERR] java.lang.Exception: Either or object must be specified in Message body to know who to signal
17:25:09,472 ERROR [STDERR] at org.jboss.soa.esb.services.jbpm.actions.impl.DefaultCommandExecutorFactoryImpl$8.execute(DefaultCommandExecutorFactoryImpl.java:270)
17:25:09,472 ERROR [STDERR] at org.jboss.soa.esb.services.jbpm.actions.CommandInterpreter.process(CommandInterpreter.java:78)
17:25:09,472 ERROR [STDERR] at org.jboss.soa.esb.services.jbpm.actions.BpmProcessor.process(BpmProcessor.java:64)
17:25:09,473 ERROR [STDERR] at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
17:25:09,473 ERROR [STDERR] at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
17:25:09,473 ERROR [STDERR] at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
17:25:09,473 ERROR [STDERR] at java.lang.reflect.Method.invoke(Method.java:597)
17:25:09,473 ERROR [STDERR] at org.jboss.soa.esb.listeners.message.ActionProcessorMethodInfo.processMethods(ActionProcessorMethodInfo.java:102)
17:25:09,473 ERROR [STDERR] at org.jboss.soa.esb.listeners.message.OverriddenActionLifecycleProcessor.process(OverriddenActionLifecycleProcessor.java:74)
17:25:09,473 ERROR [STDERR] at org.jboss.soa.esb.listeners.message.ActionProcessingPipeline.process(ActionProcessingPipeline.java:253)
17:25:09,473 ERROR [STDERR] at org.jboss.soa.esb.listeners.message.MessageAwareListener$1.run(MessageAwareListener.java:301)
17:25:09,473 ERROR [STDERR] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:885)
17:25:09,473 ERROR [STDERR] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:907)
17:25:09,473 ERROR [STDERR] at java.lang.Thread.run(Thread.java:619)
17:25:09,473 WARN [ActionProcessingPipeline] Unexpected exception caught while processing the action pipeline
org.jboss.soa.esb.actions.ActionProcessingException: java.lang.Exception: Either or object must be specified in Message body to know who to signal
at org.jboss.soa.esb.services.jbpm.actions.CommandInterpreter.process(CommandInterpreter.java:83)
at org.jboss.soa.esb.services.jbpm.actions.BpmProcessor.process(BpmProcessor.java:64)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
at java.lang.reflect.Method.invoke(Method.java:597)
at org.jboss.soa.esb.listeners.message.ActionProcessorMethodInfo.processMethods(ActionProcessorMethodInfo.java:102)
at org.jboss.soa.esb.listeners.message.OverriddenActionLifecycleProcessor.process(OverriddenActionLifecycleProcessor.java:74)
at org.jboss.soa.esb.listeners.message.ActionProcessingPipeline.process(ActionProcessingPipeline.java:253)
at org.jboss.soa.esb.listeners.message.MessageAwareListener$1.run(MessageAwareListener.java:301)
at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:885)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:907)
at java.lang.Thread.run(Thread.java:619)
Caused by: java.lang.Exception: Either or object must be specified in Message body to know who to signal
at org.jboss.soa.esb.services.jbpm.actions.impl.DefaultCommandExecutorFactoryImpl$8.execute(DefaultCommandExecutorFactoryImpl.java:270)
at org.jboss.soa.esb.services.jbpm.actions.CommandInterpreter.process(CommandInterpreter.java:78)
... 12 more
17:25:09,475 ERROR [ActionProcessingPipeline] Failed to send error to address null.
org.jboss.soa.esb.couriers.CourierException: No deliverAsync courier
at org.jboss.internal.soa.esb.couriers.TwoWayCourierImpl.deliver(TwoWayCourierImpl.java:166)
at org.jboss.soa.esb.listeners.message.ActionProcessingPipeline.faultTo(ActionProcessingPipeline.java:436)
at org.jboss.soa.esb.listeners.message.ActionProcessingPipeline.process(ActionProcessingPipeline.java:287)
at org.jboss.soa.esb.listeners.message.MessageAwareListener$1.run(MessageAwareListener.java:301)
at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:885)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:907)
at java.lang.Thread.run(Thread.java:619)
Little bit afraid what the last errors meant, but fear not, run the former task.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant startProcess
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
startProcess:
[echo] Sends a message to start the process instance
[java] Here
BUILD SUCCESSFUL
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$
This time the output from JBoss AS log
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
clean:
Overriding previous definition of reference to quickstart-dependencies-classpath
quickstart-specific-clean:
[echo] No Quickstart specific 'clean' being made.
prepare:
BUILD FAILED
/home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build.xml:26: /home/jarkko/esb42MR2/esb/build/jbossesb/lib/jbpm.esb not found.
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$
build.xml has some wrong paths:
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ diff -u build.xml.orig build.xml
--- build.xml.orig 2007-05-09 17:07:46.661004119 +0300
+++ build.xml 2007-05-09 17:08:06.578139132 +0300
@@ -9,7 +9,7 @@
<import file="../conf/base-build.xml"/>
<!--property name="jbpm.services.build.dir" value="${product.dir}/build/services/jbpm.esb" /-->
- <property name="jbpm.services.build.dir" value="${product.dir}/build/services/jbpm.esb" />
+ <property name="jbpm.services.build.dir" value="${product.dir}/lib/jbpm.esb" />
<property name="jbossesb.inputdir" location="/tmp"/>
<property name="project.process.dir" value="processDefinition1"/>
Ok, now we can move one building and deploying the example.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant deploy
Buildfile: build.xmljarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$
Overriding previous definition of reference to quickstart-dependencies-classpath
clean:
Overriding previous definition of reference to quickstart-dependencies-classpath
quickstart-specific-clean:
[echo] No Quickstart specific 'clean' being made.
prepare:
[copy] Copying 11 files to /home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build/Quickstart_bpm_orchestration1.esb
[mkdir] Created dir: /home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build/classes
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
[javac] Compiling 4 source files to /home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build/classes
esb:
[copy] Copying 1 file to /home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build/Quickstart_bpm_orchestration1.esb/META-INF
[copy] Copying 1 file to /home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build/Quickstart_bpm_orchestration1.esb
[copy] Copying 4 files to /home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build/Quickstart_bpm_orchestration1.esb
[mkdir] Created dir: /home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build/Quickstart_bpm_orchestration1.esb/scripts
[copy] Copying 3 files to /home/jarkko/esb42MR2/esb/samples/quickstarts/bpm_orchestration1/build/Quickstart_bpm_orchestration1.esb/scripts
deploy:
[delete] Deleting directory /home/jarkko/esb42MR2/esb-server/server/default/deploy/Quickstart_bpm_orchestration1.esb
[copy] Copying 19 files to /home/jarkko/esb42MR2/esb-server/server/default/deploy/Quickstart_bpm_orchestration1.esb
BUILD SUCCESSFUL
Total time: 2 seconds
And output from JBoss AS log:
17:22:12,771 INFO [JDBCDataStore] Generated token 'authToken:ADF50020-FE38-11DB-8020-D728FCEB68B4' for user: 'jbossesb/JBoss ESB User'
17:22:12,780 INFO [DeleteBindingFunction] Publisher 'jbossesb' deleted BindingTemplate with key: 3C81E110-FE38-11DB-A110-EA5E026CBB4A
17:22:12,781 INFO [STDOUT] 1
17:22:12,827 INFO [JDBCDataStore] Generated token 'authToken:ADFD8BA0-FE38-11DB-8BA0-A52A01045DF7' for user: 'jbossesb/JBoss ESB User'
17:22:12,832 INFO [DeleteBindingFunction] Publisher 'jbossesb' deleted BindingTemplate with key: 3C7C62D0-FE38-11DB-A2D0-8B6ABA700E1D
17:22:12,832 INFO [STDOUT] 1
17:22:12,869 INFO [JDBCDataStore] Generated token 'authToken:AE041B50-FE38-11DB-9B50-DD302D395CC8' for user: 'jbossesb/JBoss ESB User'
17:22:12,874 INFO [DeleteBindingFunction] Publisher 'jbossesb' deleted BindingTemplate with key: 3C786B30-FE38-11DB-AB30-DD34B25E5496
17:22:12,874 INFO [STDOUT] 1
17:22:12,927 INFO [JDBCDataStore] Generated token 'authToken:AE0BE380-FE38-11DB-A380-C0AD1714B89E' for user: 'jbossesb/JBoss ESB User'
17:22:12,932 INFO [DeleteBindingFunction] Publisher 'jbossesb' deleted BindingTemplate with key: 3C733B10-FE38-11DB-BB10-EDED9B6D0DFA
17:22:12,932 INFO [STDOUT] 1
17:22:12,932 INFO [CommandInterpreter] destroy() invoked
17:22:12,932 INFO [CommandInterpreter] destroy() invoked
17:22:12,980 INFO [JDBCDataStore] Generated token 'authToken:AE146F00-FE38-11DB-AF00-FFDAB948A3DC' for user: 'jbossesb/JBoss ESB User'
17:22:12,986 INFO [DeleteBindingFunction] Publisher 'jbossesb' deleted BindingTemplate with key: 3C6ECE40-FE38-11DB-8E40-E5659A11C7A8
17:22:12,987 INFO [STDOUT] 1
17:22:12,987 INFO [CommandInterpreter] destroy() invoked
17:22:13,025 INFO [JDBCDataStore] Generated token 'authToken:AE1BC200-FE38-11DB-8200-E37C1AD2BF67' for user: 'jbossesb/JBoss ESB User'
17:22:13,031 INFO [DeleteBindingFunction] Publisher 'jbossesb' deleted BindingTemplate with key: 3C68B3C0-FE38-11DB-B3C0-9CF9366FE6B4
17:22:13,032 INFO [STDOUT] 1
17:22:13,212 ERROR [ClosedInterceptor] ClosedInterceptor.ClientConsumerDelegate[7]: method receive() did not go through, the interceptor is CLOSED
17:22:13,237 WARN [BisocketServerInvoker] unrecognized listener ID: 3j011-dzwr8s-f1hvn87z-1-f1hvnpqc-d
17:22:13,711 INFO [JBoss4ESBDeployer] create esb service, Quickstart_bpm_orchestration1.esb
17:22:13,921 INFO [CommandInterpreter] initialise() invoked - config=
17:22:13,957 INFO [JDBCDataStore] Generated token 'authToken:AEA8BFC0-FE38-11DB-BFC0-91ED0E4A7AD8' for user: 'jbossesb/JBoss ESB User'
17:22:13,969 INFO [CommandInterpreter] initialise() invoked - config=
17:22:13,970 INFO [CommandInterpreter] initialise() invoked - config=
17:22:13,988 INFO [JDBCDataStore] Generated token 'authToken:AEAE8C20-FE38-11DB-8C20-FBCE7DF33839' for user: 'jbossesb/JBoss ESB User'
17:22:14,043 INFO [JDBCDataStore] Generated token 'authToken:AEB34710-FE38-11DB-8710-F203D0BD138D' for user: 'jbossesb/JBoss ESB User'
17:22:14,082 INFO [JDBCDataStore] Generated token 'authToken:AEBC47C0-FE38-11DB-87C0-B9C7B6709E19' for user: 'jbossesb/JBoss ESB User'
17:22:14,118 INFO [JDBCDataStore] Generated token 'authToken:AEC28950-FE38-11DB-8950-EBBC25E3FC25' for user: 'jbossesb/JBoss ESB User'
17:22:14,161 INFO [JDBCDataStore] Generated token 'authToken:AEC87CC0-FE38-11DB-BCC0-CA66A4D38E3D' for user: 'jbossesb/JBoss ESB User'
Then try to run the test, but alas, there's no such target runtest in the build.xml:
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant runtest
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
BUILD FAILED
Target `runtest' does not exist in this project.
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$
From build.xml I found couple interesting tasks, deployProcess and startProcess, lest run the first one first.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant startProcess
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
startProcess:
[echo] Sends a message to start the process instance
[java] Here
BUILD SUCCESSFUL
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant deployProcess
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
deployProcess:
[echo] Sends a message to deploy the process definition
[java] Here
BUILD SUCCESSFUL
Total time: 1 second
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$
And again there's a lot of output from JBoss AS log:
17:25:04,853 INFO [MessageSpy] Body: Start It Up
17:25:04,990 INFO [Environment] Hibernate 3.2.1
17:25:04,998 INFO [Environment] hibernate.properties not found
17:25:05,001 INFO [Environment] Bytecode provider name : cglib
17:25:05,006 INFO [Environment] using JDK 1.4 java.sql.Timestamp handling
17:25:05,081 INFO [Configuration] configuring from resource: hibernate.cfg.xml
17:25:05,081 INFO [Configuration] Configuration resource: hibernate.cfg.xml
17:25:05,105 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/action/Script.hbm.xml
17:25:05,181 INFO [Configuration] Reading mappings from resource : org/jbpm/identity/User.hbm.xml
17:25:05,212 INFO [HbmBinder] Mapping class: org.jbpm.identity.User -> JBPM_ID_USER
17:25:05,246 INFO [HbmBinder] Mapping collection: org.jbpm.identity.User.permissions -> JBPM_ID_PERMISSIONS
17:25:05,246 INFO [Configuration] Reading mappings from resource : org/jbpm/identity/Group.hbm.xml
17:25:05,287 INFO [HbmBinder] Mapping class: org.jbpm.identity.Group -> JBPM_ID_GROUP
17:25:05,408 INFO [HbmBinder] Mapping collection: org.jbpm.identity.Group.permissions -> JBPM_ID_PERMISSIONS
17:25:05,409 INFO [Configuration] Reading mappings from resource : org/jbpm/identity/Membership.hbm.xml
17:25:05,425 INFO [HbmBinder] Mapping class: org.jbpm.identity.Membership -> JBPM_ID_MEMBERSHIP
17:25:05,426 INFO [HbmBinder] Mapping collection: org.jbpm.identity.Membership.permissions -> JBPM_ID_PERMISSIONS
17:25:05,427 INFO [Configuration] Reading mappings from resource : org/jbpm/db/hibernate.queries.hbm.xml
17:25:05,521 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/ProcessDefinition.hbm.xml
17:25:05,539 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.ProcessDefinition -> JBPM_PROCESSDEFINITION
17:25:05,550 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/Node.hbm.xml
17:25:05,751 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.Node -> JBPM_NODE
17:25:05,767 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/Transition.hbm.xml
17:25:05,861 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.Transition -> JBPM_TRANSITION
17:25:05,862 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/Event.hbm.xml
17:25:05,929 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.Event -> JBPM_EVENT
17:25:05,930 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/Action.hbm.xml
17:25:05,942 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.Action -> JBPM_ACTION
17:25:05,944 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/SuperState.hbm.xml
17:25:05,986 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.def.SuperState -> JBPM_NODE
17:25:05,986 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/def/ExceptionHandler.hbm.xml
17:25:06,121 INFO [HbmBinder] Mapping class: org.jbpm.graph.def.ExceptionHandler -> JBPM_EXCEPTIONHANDLER
17:25:06,122 INFO [Configuration] Reading mappings from resource : org/jbpm/instantiation/Delegation.hbm.xml
17:25:06,135 INFO [HbmBinder] Mapping class: org.jbpm.instantiation.Delegation -> JBPM_DELEGATION
17:25:06,136 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/StartState.hbm.xml
17:25:06,193 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.StartState -> JBPM_NODE
17:25:06,194 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/EndState.hbm.xml
17:25:06,202 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.EndState -> JBPM_NODE
17:25:06,203 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/ProcessState.hbm.xml
17:25:06,216 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.ProcessState -> JBPM_NODE
17:25:06,219 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/Decision.hbm.xml
17:25:06,634 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.Decision -> JBPM_NODE
17:25:06,636 INFO [HbmBinder] Mapping collection: org.jbpm.graph.node.Decision.decisionConditions -> JBPM_DECISIONCONDITIONS
17:25:06,636 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/Fork.hbm.xml
17:25:06,642 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.Fork -> JBPM_NODE
17:25:06,643 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/Join.hbm.xml
17:25:06,648 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.Join -> JBPM_NODE
17:25:06,649 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/State.hbm.xml
17:25:06,659 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.State -> JBPM_NODE
17:25:06,659 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/node/TaskNode.hbm.xml
17:25:06,670 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.node.TaskNode -> JBPM_NODE
17:25:06,671 INFO [Configuration] Reading mappings from resource : org/jbpm/context/def/ContextDefinition.hbm.xml
17:25:06,677 INFO [Configuration] Reading mappings from resource : org/jbpm/context/def/VariableAccess.hbm.xml
17:25:06,683 INFO [HbmBinder] Mapping class: org.jbpm.context.def.VariableAccess -> JBPM_VARIABLEACCESS
17:25:06,686 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/def/TaskMgmtDefinition.hbm.xml
17:25:06,692 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/def/Swimlane.hbm.xml
17:25:06,698 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.def.Swimlane -> JBPM_SWIMLANE
17:25:06,700 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/def/Task.hbm.xml
17:25:06,712 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.def.Task -> JBPM_TASK
17:25:06,717 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/def/TaskController.hbm.xml
17:25:06,723 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.def.TaskController -> JBPM_TASKCONTROLLER
17:25:06,725 INFO [Configuration] Reading mappings from resource : org/jbpm/module/def/ModuleDefinition.hbm.xml
17:25:06,731 INFO [HbmBinder] Mapping class: org.jbpm.module.def.ModuleDefinition -> JBPM_MODULEDEFINITION
17:25:06,732 INFO [Configuration] Reading mappings from resource : org/jbpm/bytes/ByteArray.hbm.xml
17:25:06,738 INFO [HbmBinder] Mapping class: org.jbpm.bytes.ByteArray -> JBPM_BYTEARRAY
17:25:06,740 INFO [HbmBinder] Mapping collection: org.jbpm.bytes.ByteArray.byteBlocks -> JBPM_BYTEBLOCK
17:25:06,740 INFO [Configuration] Reading mappings from resource : org/jbpm/file/def/FileDefinition.hbm.xml
17:25:06,745 INFO [HbmBinder] Mapping subclass: org.jbpm.file.def.FileDefinition -> JBPM_MODULEDEFINITION
17:25:06,746 INFO [Configuration] Reading mappings from resource : org/jbpm/scheduler/def/CreateTimerAction.hbm.xml
17:25:06,751 INFO [HbmBinder] Mapping subclass: org.jbpm.scheduler.def.CreateTimerAction -> JBPM_ACTION
17:25:06,753 INFO [Configuration] Reading mappings from resource : org/jbpm/scheduler/def/CancelTimerAction.hbm.xml
17:25:06,759 INFO [HbmBinder] Mapping subclass: org.jbpm.scheduler.def.CancelTimerAction -> JBPM_ACTION
17:25:06,759 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/exe/Comment.hbm.xml
17:25:06,766 INFO [HbmBinder] Mapping class: org.jbpm.graph.exe.Comment -> JBPM_COMMENT
17:25:06,768 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/exe/ProcessInstance.hbm.xml
17:25:06,794 INFO [HbmBinder] Mapping class: org.jbpm.graph.exe.ProcessInstance -> JBPM_PROCESSINSTANCE
17:25:06,800 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/exe/Token.hbm.xml
17:25:06,807 INFO [HbmBinder] Mapping class: org.jbpm.graph.exe.Token -> JBPM_TOKEN
17:25:06,813 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/exe/RuntimeAction.hbm.xml
17:25:06,820 INFO [HbmBinder] Mapping class: org.jbpm.graph.exe.RuntimeAction -> JBPM_RUNTIMEACTION
17:25:06,821 INFO [Configuration] Reading mappings from resource : org/jbpm/module/exe/ModuleInstance.hbm.xml
17:25:06,826 INFO [HbmBinder] Mapping class: org.jbpm.module.exe.ModuleInstance -> JBPM_MODULEINSTANCE
17:25:06,827 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/ContextInstance.hbm.xml
17:25:06,833 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.ContextInstance -> JBPM_MODULEINSTANCE
17:25:06,833 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/TokenVariableMap.hbm.xml
17:25:06,839 INFO [HbmBinder] Mapping class: org.jbpm.context.exe.TokenVariableMap -> JBPM_TOKENVARIABLEMAP
17:25:06,843 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/VariableInstance.hbm.xml
17:25:06,849 INFO [HbmBinder] Mapping class: org.jbpm.context.exe.VariableInstance -> JBPM_VARIABLEINSTANCE
17:25:06,853 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/ByteArrayInstance.hbm.xml
17:25:06,858 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.ByteArrayInstance -> JBPM_VARIABLEINSTANCE
17:25:06,858 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/DateInstance.hbm.xml
17:25:06,867 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.DateInstance -> JBPM_VARIABLEINSTANCE
17:25:06,867 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/DoubleInstance.hbm.xml
17:25:06,872 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.DoubleInstance -> JBPM_VARIABLEINSTANCE
17:25:06,873 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/HibernateLongInstance.hbm.xml
17:25:06,878 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.HibernateLongInstance -> JBPM_VARIABLEINSTANCE
17:25:06,878 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/HibernateStringInstance.hbm.xml
17:25:06,886 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.HibernateStringInstance -> JBPM_VARIABLEINSTANCE
17:25:06,886 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/LongInstance.hbm.xml
17:25:06,891 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.LongInstance -> JBPM_VARIABLEINSTANCE
17:25:06,892 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/NullInstance.hbm.xml
17:25:06,896 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.NullInstance -> JBPM_VARIABLEINSTANCE
17:25:06,896 INFO [Configuration] Reading mappings from resource : org/jbpm/context/exe/variableinstance/StringInstance.hbm.xml
17:25:06,901 INFO [HbmBinder] Mapping subclass: org.jbpm.context.exe.variableinstance.StringInstance -> JBPM_VARIABLEINSTANCE
17:25:06,901 INFO [Configuration] Reading mappings from resource : org/jbpm/job/Job.hbm.xml
17:25:06,907 INFO [HbmBinder] Mapping class: org.jbpm.job.Job -> JBPM_JOB
17:25:06,909 INFO [Configuration] Reading mappings from resource : org/jbpm/job/Timer.hbm.xml
17:25:06,915 INFO [HbmBinder] Mapping subclass: org.jbpm.job.Timer -> JBPM_JOB
17:25:06,917 INFO [Configuration] Reading mappings from resource : org/jbpm/job/ExecuteNodeJob.hbm.xml
17:25:06,922 INFO [HbmBinder] Mapping subclass: org.jbpm.job.ExecuteNodeJob -> JBPM_JOB
17:25:06,923 INFO [Configuration] Reading mappings from resource : org/jbpm/job/ExecuteActionJob.hbm.xml
17:25:06,927 INFO [HbmBinder] Mapping subclass: org.jbpm.job.ExecuteActionJob -> JBPM_JOB
17:25:06,928 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/exe/TaskMgmtInstance.hbm.xml
17:25:06,954 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.exe.TaskMgmtInstance -> JBPM_MODULEINSTANCE
17:25:06,958 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/exe/TaskInstance.hbm.xml
17:25:07,030 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.exe.TaskInstance -> JBPM_TASKINSTANCE
17:25:07,036 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskInstance.pooledActors -> JBPM_TASKACTORPOOL
17:25:07,037 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/exe/PooledActor.hbm.xml
17:25:07,042 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.exe.PooledActor -> JBPM_POOLEDACTOR
17:25:07,044 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.PooledActor.taskInstances -> JBPM_TASKACTORPOOL
17:25:07,044 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/exe/SwimlaneInstance.hbm.xml
17:25:07,050 INFO [HbmBinder] Mapping class: org.jbpm.taskmgmt.exe.SwimlaneInstance -> JBPM_SWIMLANEINSTANCE
17:25:07,051 INFO [Configuration] Reading mappings from resource : org/jbpm/logging/log/ProcessLog.hbm.xml
17:25:07,056 INFO [HbmBinder] Mapping class: org.jbpm.logging.log.ProcessLog -> JBPM_LOG
17:25:07,057 INFO [Configuration] Reading mappings from resource : org/jbpm/logging/log/MessageLog.hbm.xml
17:25:07,062 INFO [HbmBinder] Mapping subclass: org.jbpm.logging.log.MessageLog -> JBPM_LOG
17:25:07,062 INFO [Configuration] Reading mappings from resource : org/jbpm/logging/log/CompositeLog.hbm.xml
17:25:07,067 INFO [HbmBinder] Mapping subclass: org.jbpm.logging.log.CompositeLog -> JBPM_LOG
17:25:07,067 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/ActionLog.hbm.xml
17:25:07,072 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.ActionLog -> JBPM_LOG
17:25:07,072 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/NodeLog.hbm.xml
17:25:07,077 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.NodeLog -> JBPM_LOG
17:25:07,078 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/ProcessInstanceCreateLog.hbm.xml
17:25:07,083 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.ProcessInstanceCreateLog -> JBPM_LOG
17:25:07,083 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/ProcessInstanceEndLog.hbm.xml
17:25:07,087 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.ProcessInstanceEndLog -> JBPM_LOG
17:25:07,088 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/ProcessStateLog.hbm.xml
17:25:07,092 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.ProcessStateLog -> JBPM_LOG
17:25:07,093 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/SignalLog.hbm.xml
17:25:07,097 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.SignalLog -> JBPM_LOG
17:25:07,098 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/TokenCreateLog.hbm.xml
17:25:07,102 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.TokenCreateLog -> JBPM_LOG
17:25:07,102 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/TokenEndLog.hbm.xml
17:25:07,110 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.TokenEndLog -> JBPM_LOG
17:25:07,111 INFO [Configuration] Reading mappings from resource : org/jbpm/graph/log/TransitionLog.hbm.xml
17:25:07,116 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.log.TransitionLog -> JBPM_LOG
17:25:07,116 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/VariableLog.hbm.xml
17:25:07,139 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.VariableLog -> JBPM_LOG
17:25:07,139 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/VariableCreateLog.hbm.xml
17:25:07,146 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.VariableCreateLog -> JBPM_LOG
17:25:07,146 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/VariableDeleteLog.hbm.xml
17:25:07,150 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.VariableDeleteLog -> JBPM_LOG
17:25:07,151 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/VariableUpdateLog.hbm.xml
17:25:07,155 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.VariableUpdateLog -> JBPM_LOG
17:25:07,155 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/ByteArrayUpdateLog.hbm.xml
17:25:07,160 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.ByteArrayUpdateLog -> JBPM_LOG
17:25:07,160 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/DateUpdateLog.hbm.xml
17:25:07,164 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.DateUpdateLog -> JBPM_LOG
17:25:07,165 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/DoubleUpdateLog.hbm.xml
17:25:07,170 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.DoubleUpdateLog -> JBPM_LOG
17:25:07,170 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/HibernateLongUpdateLog.hbm.xml
17:25:07,175 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.HibernateLongUpdateLog -> JBPM_LOG
17:25:07,175 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/HibernateStringUpdateLog.hbm.xml
17:25:07,180 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.HibernateStringUpdateLog -> JBPM_LOG
17:25:07,180 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/LongUpdateLog.hbm.xml
17:25:07,185 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.LongUpdateLog -> JBPM_LOG
17:25:07,185 INFO [Configuration] Reading mappings from resource : org/jbpm/context/log/variableinstance/StringUpdateLog.hbm.xml
17:25:07,189 INFO [HbmBinder] Mapping subclass: org.jbpm.context.log.variableinstance.StringUpdateLog -> JBPM_LOG
17:25:07,190 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/TaskLog.hbm.xml
17:25:07,195 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.TaskLog -> JBPM_LOG
17:25:07,195 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/TaskCreateLog.hbm.xml
17:25:07,199 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.TaskCreateLog -> JBPM_LOG
17:25:07,200 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/TaskAssignLog.hbm.xml
17:25:07,204 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.TaskAssignLog -> JBPM_LOG
17:25:07,205 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/TaskEndLog.hbm.xml
17:25:07,209 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.TaskEndLog -> JBPM_LOG
17:25:07,210 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/SwimlaneLog.hbm.xml
17:25:07,218 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.SwimlaneLog -> JBPM_LOG
17:25:07,218 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/SwimlaneCreateLog.hbm.xml
17:25:07,223 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.SwimlaneCreateLog -> JBPM_LOG
17:25:07,225 INFO [Configuration] Reading mappings from resource : org/jbpm/taskmgmt/log/SwimlaneAssignLog.hbm.xml
17:25:07,229 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.log.SwimlaneAssignLog -> JBPM_LOG
17:25:07,231 INFO [Configuration] Configured SessionFactory: null
17:25:07,231 INFO [HbmBinder] Mapping subclass: org.jbpm.graph.action.Script -> JBPM_ACTION
17:25:07,234 INFO [HbmBinder] Mapping subclass: org.jbpm.taskmgmt.def.TaskMgmtDefinition -> JBPM_MODULEDEFINITION
17:25:07,234 INFO [HbmBinder] Mapping subclass: org.jbpm.context.def.ContextDefinition -> JBPM_MODULEDEFINITION
17:25:07,235 INFO [HbmBinder] Mapping collection: org.jbpm.identity.User.memberships -> JBPM_ID_MEMBERSHIP
17:25:07,236 INFO [HbmBinder] Mapping collection: org.jbpm.identity.Group.children -> JBPM_ID_GROUP
17:25:07,236 INFO [HbmBinder] Mapping collection: org.jbpm.identity.Group.memberships -> JBPM_ID_MEMBERSHIP
17:25:07,236 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.events -> JBPM_EVENT
17:25:07,237 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.exceptionHandlers -> JBPM_EXCEPTIONHANDLER
17:25:07,237 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.nodes -> JBPM_NODE
17:25:07,237 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.actions -> JBPM_ACTION
17:25:07,238 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ProcessDefinition.definitions -> JBPM_MODULEDEFINITION
17:25:07,238 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Node.events -> JBPM_EVENT
17:25:07,238 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Node.exceptionHandlers -> JBPM_EXCEPTIONHANDLER
17:25:07,238 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Node.leavingTransitions -> JBPM_TRANSITION
17:25:07,239 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Node.arrivingTransitions -> JBPM_TRANSITION
17:25:07,239 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Transition.events -> JBPM_EVENT
17:25:07,239 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Transition.exceptionHandlers -> JBPM_EXCEPTIONHANDLER
17:25:07,239 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.Event.actions -> JBPM_ACTION
17:25:07,240 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.SuperState.nodes -> JBPM_NODE
17:25:07,240 INFO [HbmBinder] Mapping collection: org.jbpm.graph.def.ExceptionHandler.actions -> JBPM_ACTION
17:25:07,240 INFO [HbmBinder] Mapping collection: org.jbpm.graph.node.ProcessState.variableAccesses -> JBPM_VARIABLEACCESS
17:25:07,249 INFO [HbmBinder] Mapping collection: org.jbpm.graph.node.TaskNode.tasks -> JBPM_TASK
17:25:07,249 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.Swimlane.tasks -> JBPM_TASK
17:25:07,249 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.Task.events -> JBPM_EVENT
17:25:07,249 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.Task.exceptionHandlers -> JBPM_EXCEPTIONHANDLER
17:25:07,250 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.TaskController.variableAccesses -> JBPM_VARIABLEACCESS
17:25:07,250 INFO [HbmBinder] Mapping collection: org.jbpm.file.def.FileDefinition.processFiles -> JBPM_BYTEARRAY
17:25:07,250 INFO [HbmBinder] Mapping collection: org.jbpm.graph.exe.ProcessInstance.runtimeActions -> JBPM_RUNTIMEACTION
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.graph.exe.ProcessInstance.instances -> JBPM_MODULEINSTANCE
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.graph.exe.Token.children -> JBPM_TOKEN
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.graph.exe.Token.comments -> JBPM_COMMENT
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.context.exe.ContextInstance.tokenVariableMaps -> JBPM_TOKENVARIABLEMAP
17:25:07,251 INFO [HbmBinder] Mapping collection: org.jbpm.context.exe.TokenVariableMap.variableInstances -> JBPM_VARIABLEINSTANCE
17:25:07,252 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskMgmtInstance.swimlaneInstances -> JBPM_SWIMLANEINSTANCE
17:25:07,252 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskMgmtInstance.taskInstances -> JBPM_TASKINSTANCE
17:25:07,252 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskInstance.variableInstances -> JBPM_VARIABLEINSTANCE
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.TaskInstance.comments -> JBPM_COMMENT
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.exe.SwimlaneInstance.pooledActors -> JBPM_POOLEDACTOR
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.logging.log.CompositeLog.children -> JBPM_LOG
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.graph.action.Script.variableAccesses -> JBPM_VARIABLEACCESS
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.TaskMgmtDefinition.swimlanes -> JBPM_SWIMLANE
17:25:07,253 INFO [HbmBinder] Mapping collection: org.jbpm.taskmgmt.def.TaskMgmtDefinition.tasks -> JBPM_TASK
17:25:07,306 INFO [DriverManagerConnectionProvider] Using Hibernate built-in connection pool (not for production use!)
17:25:07,306 INFO [DriverManagerConnectionProvider] Hibernate connection pool size: 20
17:25:07,306 INFO [DriverManagerConnectionProvider] autocommit mode: false
17:25:07,306 INFO [DriverManagerConnectionProvider] using driver: org.hsqldb.jdbcDriver at URL: jdbc:hsqldb:mem:jbpm
17:25:07,306 INFO [DriverManagerConnectionProvider] connection properties: {user=sa, password=}
17:25:07,314 INFO [SettingsFactory] RDBMS: HSQL Database Engine, version: 1.8.0
17:25:07,314 INFO [SettingsFactory] JDBC driver: HSQL Database Engine Driver, version: 1.8.0
17:25:07,331 INFO [Dialect] Using dialect: org.hibernate.dialect.HSQLDialect
17:25:07,337 INFO [TransactionFactoryFactory] Using default transaction strategy (direct JDBC transactions)
17:25:07,339 INFO [TransactionManagerLookupFactory] No TransactionManagerLookup configured (in JTA environment, use of read-write or transactional second-level cache is not recommended)
17:25:07,339 INFO [SettingsFactory] Automatic flush during beforeCompletion(): disabled
17:25:07,339 INFO [SettingsFactory] Automatic session close at end of transaction: disabled
17:25:07,339 INFO [SettingsFactory] JDBC batch size: 15
17:25:07,339 INFO [SettingsFactory] JDBC batch updates for versioned data: disabled
17:25:07,340 INFO [SettingsFactory] Scrollable result sets: enabled
17:25:07,340 INFO [SettingsFactory] JDBC3 getGeneratedKeys(): disabled
17:25:07,340 INFO [SettingsFactory] Connection release mode: auto
17:25:07,341 INFO [SettingsFactory] Default batch fetch size: 1
17:25:07,341 INFO [SettingsFactory] Generate SQL with comments: disabled
17:25:07,341 INFO [SettingsFactory] Order SQL updates by primary key: disabled
17:25:07,341 INFO [SettingsFactory] Query translator: org.hibernate.hql.ast.ASTQueryTranslatorFactory
17:25:07,343 INFO [ASTQueryTranslatorFactory] Using ASTQueryTranslatorFactory
17:25:07,343 INFO [SettingsFactory] Query language substitutions: {}
17:25:07,343 INFO [SettingsFactory] JPA-QL strict compliance: disabled
17:25:07,343 INFO [SettingsFactory] Second-level cache: enabled
17:25:07,343 INFO [SettingsFactory] Query cache: disabled
17:25:07,344 INFO [SettingsFactory] Cache provider: org.hibernate.cache.HashtableCacheProvider
17:25:07,345 INFO [SettingsFactory] Optimize cache for minimal puts: disabled
17:25:07,345 INFO [SettingsFactory] Structured second-level cache entries: disabled
17:25:07,350 INFO [SettingsFactory] Statistics: disabled
17:25:07,350 INFO [SettingsFactory] Deleted entity synthetic identifier rollback: disabled
17:25:07,350 INFO [SettingsFactory] Default entity-mode: pojo
17:25:07,375 INFO [SessionFactoryImpl] building session factory
17:25:08,681 INFO [SessionFactoryObjectFactory] Not binding factory to JNDI, no JNDI name configured
17:25:08,697 INFO [SchemaExport] Running hbm2ddl schema export
17:25:08,699 INFO [SchemaExport] exporting generated schema to database
17:25:08,738 INFO [SchemaExport] schema export complete
17:25:09,471 INFO [ProcessInfo] Token ID: null
17:25:09,471 INFO [ProcessInfo] Process Name: null
17:25:09,471 INFO [ProcessInfo] Process Version: null
17:25:09,471 INFO [MessageSpy] Body Contents are NULL
17:25:09,472 ERROR [STDERR] java.lang.Exception: Either
17:25:09,472 ERROR [STDERR] at org.jboss.soa.esb.services.jbpm.actions.impl.DefaultCommandExecutorFactoryImpl$8.execute(DefaultCommandExecutorFactoryImpl.java:270)
17:25:09,472 ERROR [STDERR] at org.jboss.soa.esb.services.jbpm.actions.CommandInterpreter.process(CommandInterpreter.java:78)
17:25:09,472 ERROR [STDERR] at org.jboss.soa.esb.services.jbpm.actions.BpmProcessor.process(BpmProcessor.java:64)
17:25:09,473 ERROR [STDERR] at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
17:25:09,473 ERROR [STDERR] at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
17:25:09,473 ERROR [STDERR] at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
17:25:09,473 ERROR [STDERR] at java.lang.reflect.Method.invoke(Method.java:597)
17:25:09,473 ERROR [STDERR] at org.jboss.soa.esb.listeners.message.ActionProcessorMethodInfo.processMethods(ActionProcessorMethodInfo.java:102)
17:25:09,473 ERROR [STDERR] at org.jboss.soa.esb.listeners.message.OverriddenActionLifecycleProcessor.process(OverriddenActionLifecycleProcessor.java:74)
17:25:09,473 ERROR [STDERR] at org.jboss.soa.esb.listeners.message.ActionProcessingPipeline.process(ActionProcessingPipeline.java:253)
17:25:09,473 ERROR [STDERR] at org.jboss.soa.esb.listeners.message.MessageAwareListener$1.run(MessageAwareListener.java:301)
17:25:09,473 ERROR [STDERR] at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:885)
17:25:09,473 ERROR [STDERR] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:907)
17:25:09,473 ERROR [STDERR] at java.lang.Thread.run(Thread.java:619)
17:25:09,473 WARN [ActionProcessingPipeline] Unexpected exception caught while processing the action pipeline
org.jboss.soa.esb.actions.ActionProcessingException: java.lang.Exception: Either
at org.jboss.soa.esb.services.jbpm.actions.CommandInterpreter.process(CommandInterpreter.java:83)
at org.jboss.soa.esb.services.jbpm.actions.BpmProcessor.process(BpmProcessor.java:64)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
at java.lang.reflect.Method.invoke(Method.java:597)
at org.jboss.soa.esb.listeners.message.ActionProcessorMethodInfo.processMethods(ActionProcessorMethodInfo.java:102)
at org.jboss.soa.esb.listeners.message.OverriddenActionLifecycleProcessor.process(OverriddenActionLifecycleProcessor.java:74)
at org.jboss.soa.esb.listeners.message.ActionProcessingPipeline.process(ActionProcessingPipeline.java:253)
at org.jboss.soa.esb.listeners.message.MessageAwareListener$1.run(MessageAwareListener.java:301)
at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:885)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:907)
at java.lang.Thread.run(Thread.java:619)
Caused by: java.lang.Exception: Either
at org.jboss.soa.esb.services.jbpm.actions.impl.DefaultCommandExecutorFactoryImpl$8.execute(DefaultCommandExecutorFactoryImpl.java:270)
at org.jboss.soa.esb.services.jbpm.actions.CommandInterpreter.process(CommandInterpreter.java:78)
... 12 more
17:25:09,475 ERROR [ActionProcessingPipeline] Failed to send error to address null.
org.jboss.soa.esb.couriers.CourierException: No deliverAsync courier
at org.jboss.internal.soa.esb.couriers.TwoWayCourierImpl.deliver(TwoWayCourierImpl.java:166)
at org.jboss.soa.esb.listeners.message.ActionProcessingPipeline.faultTo(ActionProcessingPipeline.java:436)
at org.jboss.soa.esb.listeners.message.ActionProcessingPipeline.process(ActionProcessingPipeline.java:287)
at org.jboss.soa.esb.listeners.message.MessageAwareListener$1.run(MessageAwareListener.java:301)
at java.util.concurrent.ThreadPoolExecutor$Worker.runTask(ThreadPoolExecutor.java:885)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:907)
at java.lang.Thread.run(Thread.java:619)
Little bit afraid what the last errors meant, but fear not, run the former task.
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$ ant startProcess
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
startProcess:
[echo] Sends a message to start the process instance
[java] Here
BUILD SUCCESSFUL
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/bpm_orchestration1$
This time the output from JBoss AS log
webservice_jbossws_adapter_01
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/webservice_jbossws_adapter_01$ ant
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
config:
deploy:
[echo] Deploying Quickstart to JBoss ESB/App Server...
[mkdir] Created dir: /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_jbossws_adapter_01/build/META-INF
[copy] Copying 1 file to /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_jbossws_adapter_01/build/META-INF
Overriding previous definition of reference to quickstart-dependencies-classpath
assert-ws-available:
BUILD FAILED
/home/jarkko/esb42MR2/esb/samples/quickstarts/conf/base-build.xml:128: The following error occurred while executing this line:
/home/jarkko/esb42MR2/esb/samples/quickstarts/conf/base-build.xml:193: **** DEPLOYMENT FAILED... Sorry, this Quickstart requires a JBoss Webservice container. '${org.jboss.server.dir}' does not have a Webservice container. Check the 'jbosshome.dir' property in ../quickstarts.properties"
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/webservice_jbossws_adapter_01$
Because the JBoss configuration which comes with JBoss ESB doesn't seem to contain EJB3 profile running the WebServices examples doesn't work.
Buildfile: build.xml
Overriding previous definition of reference to quickstart-dependencies-classpath
config:
deploy:
[echo] Deploying Quickstart to JBoss ESB/App Server...
[mkdir] Created dir: /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_jbossws_adapter_01/build/META-INF
[copy] Copying 1 file to /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_jbossws_adapter_01/build/META-INF
Overriding previous definition of reference to quickstart-dependencies-classpath
assert-ws-available:
BUILD FAILED
/home/jarkko/esb42MR2/esb/samples/quickstarts/conf/base-build.xml:128: The following error occurred while executing this line:
/home/jarkko/esb42MR2/esb/samples/quickstarts/conf/base-build.xml:193: **** DEPLOYMENT FAILED... Sorry, this Quickstart requires a JBoss Webservice container. '${org.jboss.server.dir}' does not have a Webservice container. Check the 'jbosshome.dir' property in ../quickstarts.properties"
Total time: 0 seconds
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/webservice_jbossws_adapter_01$
Because the JBoss configuration which comes with JBoss ESB doesn't seem to contain EJB3 profile running the WebServices examples doesn't work.
webservice_war1
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/webservice_war1$ ant
Buildfile: build.xml
config:
deploy:
[echo] Deploying Quickstart to JBoss ESB/App Server...
[mkdir] Created dir: /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/META-INF
[copy] Copying 1 file to /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/META-INF
quickstart-specific-assemblies:
[echo] No Quickstart specific assembly tasks.
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
[mkdir] Created dir: /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/classes
[javac] Compiling 2 source files to /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/classes
package-deployment:
[jar] Building jar: /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/Quickstart_webservice_war1.esb
deploy-esb-archive-before:
assert-ws-available:
BUILD FAILED
/home/jarkko/esb42MR2/esb/samples/quickstarts/conf/base-build.xml:133: The following error occurred while executing this line:
/home/jarkko/esb42MR2/esb/samples/quickstarts/conf/base-build.xml:193: **** DEPLOYMENT FAILED... Sorry, this Quickstart requires a JBoss Webservice container. '${org.jboss.server.dir}' does not have a Webservice container. Check the 'jbosshome.dir' property in ../quickstarts.properties"
Total time: 1 second
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/webservice_war1$
So, webservice_war1 is nogo also.
Buildfile: build.xml
config:
deploy:
[echo] Deploying Quickstart to JBoss ESB/App Server...
[mkdir] Created dir: /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/META-INF
[copy] Copying 1 file to /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/META-INF
quickstart-specific-assemblies:
[echo] No Quickstart specific assembly tasks.
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
[mkdir] Created dir: /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/classes
[javac] Compiling 2 source files to /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/classes
package-deployment:
[jar] Building jar: /home/jarkko/esb42MR2/esb/samples/quickstarts/webservice_war1/build/Quickstart_webservice_war1.esb
deploy-esb-archive-before:
assert-ws-available:
BUILD FAILED
/home/jarkko/esb42MR2/esb/samples/quickstarts/conf/base-build.xml:133: The following error occurred while executing this line:
/home/jarkko/esb42MR2/esb/samples/quickstarts/conf/base-build.xml:193: **** DEPLOYMENT FAILED... Sorry, this Quickstart requires a JBoss Webservice container. '${org.jboss.server.dir}' does not have a Webservice container. Check the 'jbosshome.dir' property in ../quickstarts.properties"
Total time: 1 second
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/webservice_war1$
So, webservice_war1 is nogo also.
jbpm_simple1
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/jbpm_simple1$ ant deploy
Buildfile: build.xml
BUILD FAILED
/home/jarkko/esb42MR2/esb/samples/quickstarts/jbpm_simple1/build.xml:15: services/jbpm has not been built. Please build and re-run this target
Total time: 0 second
Thus, jbpm_simple1 is nogo with JBoss ESB 4.2 MR 2.
Buildfile: build.xml
BUILD FAILED
/home/jarkko/esb42MR2/esb/samples/quickstarts/jbpm_simple1/build.xml:15: services/jbpm has not been built. Please build and re-run this target
Total time: 0 second
Thus, jbpm_simple1 is nogo with JBoss ESB 4.2 MR 2.
scripting_groovy
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/scripting_groovy$ ant deploy
[ant log deleted]
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/scripting_groovy$ ant runtest
Buildfile: build.xml
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
runtest:
[echo] Runs Test JMS Sender
[java] Connection Started
BUILD SUCCESSFUL
Total time: 2 seconds
Then in the JBoss server log:
23:49:34,117 INFO [STDOUT] Hello World
23:49:34,623 INFO [STDOUT] iTunes Top 10 Albums
23:49:34,639 INFO [STDOUT] 1. Call Me Irresponsible - Michael Bublé
23:49:34,640 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252125607&s=143441
23:49:34,640 INFO [STDOUT] 2. The Reminder - Feist
23:49:34,640 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252525828&s=143441
23:49:34,640 INFO [STDOUT] 3. Because of You - Ne-Yo
23:49:34,640 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252385230&s=143441
23:49:34,640 INFO [STDOUT] 4. Back to Black - Amy Winehouse
23:49:34,640 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=217937847&s=143441
23:49:34,640 INFO [STDOUT] 5. Indiana - Jon McLaughlin
23:49:34,641 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252385135&s=143441
23:49:34,641 INFO [STDOUT] 6. Daughtry (Bonus Track) - Daughtry
23:49:34,641 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=204830047&s=143441
23:49:34,641 INFO [STDOUT] 7. American Doll Posse - Tori Amos
23:49:34,641 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252724791&s=143441
23:49:34,641 INFO [STDOUT] 8. Volta - Bjork
23:49:34,641 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252738426&s=143441
23:49:34,641 INFO [STDOUT] 9. Some Hearts - Carrie Underwood
23:49:34,642 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=89688709&s=143441
23:49:34,654 INFO [STDOUT] 10. Crazy Ex-Girlfriend - Miranda Lambert
23:49:34,654 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=251081798&s=143441
23:49:34,737 INFO [STDOUT] Goodbye World
23:49:34,737 INFO [STDOUT] Message modified by Groovy: Goodbye World
Later, to undeploy it:
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/scripting_groovy$ ant undeploy
Buildfile: build.xml
undeploy:
[delete] Deleting 1 files from /home/jarkko/esb42MR2/esb-server/server/default/deploy
[delete] Deleting /home/jarkko/esb42MR2/esb-server/server/default/deploy/scripting-groovy-quickstart.esb
BUILD SUCCESSFUL
Total time: 0 seconds
jarkko@azkaban:~/esb42
So, scripting_groovy sample from JBoss ESB 4.2. MR2 seems to work ok.
[ant log deleted]
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/scripting_groovy$ ant runtest
Buildfile: build.xml
qslib-dependencies:
non-qslib-dependencies:
dependencies:
compile:
runtest:
[echo] Runs Test JMS Sender
[java] Connection Started
BUILD SUCCESSFUL
Total time: 2 seconds
Then in the JBoss server log:
23:49:34,117 INFO [STDOUT] Hello World
23:49:34,623 INFO [STDOUT] iTunes Top 10 Albums
23:49:34,639 INFO [STDOUT] 1. Call Me Irresponsible - Michael Bublé
23:49:34,640 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252125607&s=143441
23:49:34,640 INFO [STDOUT] 2. The Reminder - Feist
23:49:34,640 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252525828&s=143441
23:49:34,640 INFO [STDOUT] 3. Because of You - Ne-Yo
23:49:34,640 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252385230&s=143441
23:49:34,640 INFO [STDOUT] 4. Back to Black - Amy Winehouse
23:49:34,640 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=217937847&s=143441
23:49:34,640 INFO [STDOUT] 5. Indiana - Jon McLaughlin
23:49:34,641 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252385135&s=143441
23:49:34,641 INFO [STDOUT] 6. Daughtry (Bonus Track) - Daughtry
23:49:34,641 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=204830047&s=143441
23:49:34,641 INFO [STDOUT] 7. American Doll Posse - Tori Amos
23:49:34,641 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252724791&s=143441
23:49:34,641 INFO [STDOUT] 8. Volta - Bjork
23:49:34,641 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=252738426&s=143441
23:49:34,641 INFO [STDOUT] 9. Some Hearts - Carrie Underwood
23:49:34,642 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=89688709&s=143441
23:49:34,654 INFO [STDOUT] 10. Crazy Ex-Girlfriend - Miranda Lambert
23:49:34,654 INFO [STDOUT] http://phobos.apple.com/WebObjects/MZStore.woa/wa/viewAlbum?id=251081798&s=143441
23:49:34,737 INFO [STDOUT] Goodbye World
23:49:34,737 INFO [STDOUT] Message modified by Groovy: Goodbye World
Later, to undeploy it:
jarkko@azkaban:~/esb42MR2/esb/samples/quickstarts/scripting_groovy$ ant undeploy
Buildfile: build.xml
undeploy:
[delete] Deleting 1 files from /home/jarkko/esb42MR2/esb-server/server/default/deploy
[delete] Deleting /home/jarkko/esb42MR2/esb-server/server/default/deploy/scripting-groovy-quickstart.esb
BUILD SUCCESSFUL
Total time: 0 seconds
jarkko@azkaban:~/esb42
So, scripting_groovy sample from JBoss ESB 4.2. MR2 seems to work ok.
Tilaa:
Blogitekstit (Atom)