See <http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/13... ------------------------------------------ [...truncated 8638 lines...] 14:09:24,719 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221013: Using NIO Journal 14:09:24,752 INFO [org.jboss.as.jacorb] (MSC service thread 1-4) JBAS016330: CORBA ORB Service started 14:09:25,350 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221034: Waiting to obtain live lock 14:09:25,351 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221035: Live Server Obtained live lock 14:09:26,045 INFO [org.jboss.as.server.deployment.scanner] (MSC service thread 1-5) JBAS015012: Started FileSystemDeploymentService for directory <http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws... 14:09:26,069 INFO [org.jboss.as.remoting] (MSC service thread 1-6) JBAS017100: Listening on 127.0.0.1:9999 14:09:26,071 INFO [org.jboss.as.remoting] (MSC service thread 1-8) JBAS017100: Listening on 127.0.0.1:4447 14:09:26,176 INFO [org.switchyard.component.bpel] (MSC service thread 1-3) SWITCHYARD030800: Init BPEL component 14:09:26,270 INFO [org.jboss.as.connector.subsystems.datasources] (MSC service thread 1-2) JBAS010400: Bound data source [java:jboss/datasources/ExampleDS] 14:09:26,302 INFO [org.jboss.as.jacorb] (MSC service thread 1-1) JBAS016328: CORBA Naming Service started 14:09:27,291 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221020: Started Netty Acceptor version 3.6.9.Final-redhat-1-4cc400c 127.0.0.1:5445 for CORE protocol 14:09:27,296 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221020: Started Netty Acceptor version 3.6.9.Final-redhat-1-4cc400c 127.0.0.1:5455 for CORE protocol 14:09:27,300 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221007: Server is now live 14:09:27,301 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221001: HornetQ Server version 2.3.20.Final (2.3.20, 123) [27661ed8-40f0-11e4-8801-fb90aaa7d619] 14:09:27,310 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221003: trying to deploy queue jms.queue.StoreResultQueue 14:09:27,359 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 60) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/StoreResultQueue 14:09:27,360 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 60) JBAS011601: Bound messaging object to jndi name java:/StoreResultQueue 14:09:27,397 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 73) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/RemoteConnectionFactory 14:09:27,400 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 72) HQ221003: trying to deploy queue jms.queue.NonTransactedTestQueue 14:09:27,405 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 72) JBAS011601: Bound messaging object to jndi name java:/NonTransactedTestQueue 14:09:27,407 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 72) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/NonTransactedTestQueue 14:09:27,408 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 71) HQ221003: trying to deploy queue jms.queue.TestQueue 14:09:27,414 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 71) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/TestQueue 14:09:27,417 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 71) JBAS011601: Bound messaging object to jndi name java:/TestQueue 14:09:27,419 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 70) JBAS011601: Bound messaging object to jndi name java:/ConnectionFactory 14:09:27,421 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 69) HQ221003: trying to deploy queue jms.queue.DLQ 14:09:27,424 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 69) JBAS011601: Bound messaging object to jndi name java:/jms/queue/DLQ 14:09:27,425 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 68) HQ221003: trying to deploy queue jms.queue.InOutTestQueue_replyTo 14:09:27,429 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 68) JBAS011601: Bound messaging object to jndi name java:/InOutTestQueue_replyTo 14:09:27,431 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 68) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/InOutTestQueue_replyTo 14:09:27,432 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 67) HQ221003: trying to deploy queue jms.queue.InOutTestQueue_faultTo 14:09:27,436 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 67) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/InOutTestQueue_faultTo 14:09:27,437 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 67) JBAS011601: Bound messaging object to jndi name java:/InOutTestQueue_faultTo 14:09:27,438 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 66) HQ221003: trying to deploy queue jms.queue.ExpiryQueue 14:09:27,441 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 66) JBAS011601: Bound messaging object to jndi name java:/jms/queue/ExpiryQueue 14:09:27,442 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 65) HQ221003: trying to deploy queue jms.queue.InOutTestQueue 14:09:27,449 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 65) JBAS011601: Bound messaging object to jndi name java:/InOutTestQueue 14:09:27,450 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 65) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/InOutTestQueue 14:09:27,464 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 64) HQ221003: trying to deploy queue jms.queue.ResultPropQueue 14:09:27,469 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 64) JBAS011601: Bound messaging object to jndi name java:/ResultPropQueue 14:09:27,470 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 64) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/ResultPropQueue 14:09:27,471 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 63) HQ221003: trying to deploy queue jms.queue.JCAInflowGreetingServiceQueue 14:09:27,477 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 63) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/JCAInflowGreetingServiceQueue 14:09:27,478 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 63) JBAS011601: Bound messaging object to jndi name java:/JCAInflowGreetingServiceQueue 14:09:27,479 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 62) HQ221003: trying to deploy queue jms.queue.StoreFaultQueue 14:09:27,485 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 62) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/StoreFaultQueue 14:09:27,487 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 62) JBAS011601: Bound messaging object to jndi name java:/StoreFaultQueue 14:09:27,488 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 61) HQ221003: trying to deploy queue jms.queue.ResultQueue 14:09:27,494 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 61) JBAS011601: Bound messaging object to jndi name java:/ResultQueue 14:09:27,497 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 61) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/ResultQueue 14:09:27,500 INFO [org.jboss.as.connector.deployment] (MSC service thread 1-3) JBAS010406: Registered connection factory java:/JmsXA 14:09:27,578 INFO [org.hornetq.ra] (MSC service thread 1-3) HornetQ resource adaptor started 14:09:27,580 INFO [org.jboss.as.connector.services.resourceadapters.ResourceAdapterActivatorService$ResourceAdapterActivator] (MSC service thread 1-3) IJ020002: Deployed: file://RaActivatorhornetq-ra 14:09:27,584 INFO [org.jboss.as.connector.deployment] (MSC service thread 1-6) JBAS010401: Bound JCA ConnectionFactory [java:/JmsXA] 14:09:27,737 INFO [org.jboss.as] (Controller Boot Thread) JBAS015961: Http management interface listening on http://127.0.0.1:9990/management 14:09:27,739 INFO [org.jboss.as] (Controller Boot Thread) JBAS015951: Admin console listening on http://127.0.0.1:9990 14:09:27,740 INFO [org.jboss.as] (Controller Boot Thread) JBAS015874: JBoss EAP 6.3.0.GA (AS 7.4.0.Final-redhat-19) started in 10261ms - Started 229 of 266 services (77 services are lazy, passive or on-demand) 14:09:27,890 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 25) HQ221003: trying to deploy queue jms.queue.GreetingServiceQueue 14:09:27,894 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 25) JBAS011601: Bound messaging object to jndi name java:/GreetingServiceQueue 14:09:27,896 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 25) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/GreetingServiceQueue 14:09:28,199 INFO [org.jboss.as.repository] (management-handler-thread - 3) JBAS014900: Content added at location <http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws... 14:09:28,243 INFO [org.jboss.as.server.deployment] (MSC service thread 1-4) JBAS015876: Starting deployment of "switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar" (runtime-name: "switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar") 14:09:28,776 INFO [org.jboss.weld.deployer] (MSC service thread 1-5) JBAS016002: Processing weld deployment switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar 14:09:28,896 INFO [org.jboss.weld.deployer] (MSC service thread 1-6) JBAS016005: Starting Services for CDI deployment: switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar 14:09:29,004 INFO [org.jboss.weld.Version] (MSC service thread 1-6) WELD-000900 1.1.23 (redhat) 14:09:29,037 INFO [org.switchyard] (MSC service thread 1-6) Deploying SwitchYard application 'switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar' 14:09:29,072 INFO [org.jboss.weld.deployer] (MSC service thread 1-7) JBAS016008: Starting weld service for deployment switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar 14:09:29,748 INFO [org.switchyard] (MSC service thread 1-5) Starting SwitchYard service 14:09:30,474 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-5) Apache Camel 2.0.0-SNAPSHOT (CamelContext: camel-1) is starting 14:09:30,477 INFO [org.apache.camel.management.ManagedManagementStrategy] (MSC service thread 1-5) JMX is enabled 14:09:31,146 INFO [org.apache.deltaspike.core.util.ProjectStageProducer] (MSC service thread 1-5) Computed the following DeltaSpike ProjectStage: Production 14:09:31,163 INFO [org.apache.camel.impl.converter.DefaultTypeConverter] (MSC service thread 1-5) Loaded 217 type converters 14:09:31,419 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-5) StreamCaching is not in use. If using streams then its recommended to enable stream caching. See more details at http://camel.apache.org/stream-caching.html 14:09:31,579 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-5) Total 0 routes, of which 0 is started. 14:09:31,582 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-5) Apache Camel 2.0.0-SNAPSHOT (CamelContext: camel-1) started in 1.105 seconds 14:09:31,916 INFO [org.apache.camel.impl.converter.DefaultTypeConverter] (MSC service thread 1-5) Loaded 217 type converters 14:09:35,708 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-5) Route: direct:{urn:switchyard-quickstart:camel-jms-binding:0.1.0}GreetingService started and consuming from: Endpoint[direct://%7Burn:switchyard-quickstart:camel-jms-binding:0.1.0%7DGreetingService] 14:09:36,981 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-5) Route: V1CamelJmsBindingModel/GreetingService@_GreetingService_jms_1#-677931704 started and consuming from: Endpoint[jms://queue:GreetingServiceQueue?connectionFactory=%23ConnectionFactory] 14:09:37,053 INFO [org.jboss.as.server] (management-handler-thread - 3) JBAS018559: Deployed "switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar" (runtime-name : "switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar") 14:09:43,783 INFO [stdout] (pool-6-thread-1) Hello there Restarter :-) 14:09:44,706 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (management-handler-thread - 4) Starting to graceful shutdown 1 routes (timeout 30 seconds) 14:09:44,827 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (Camel (camel-1) thread #1 - ShutdownTask) Route: V1CamelJmsBindingModel/GreetingService@_GreetingService_jms_1#-677931704 shutdown complete, was consuming from: Endpoint[jms://queue:GreetingServiceQueue?connectionFactory=%23ConnectionFactory] 14:09:44,828 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (management-handler-thread - 4) Graceful shutdown of 1 routes completed in 0 seconds 14:09:44,833 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (management-handler-thread - 4) Route: V1CamelJmsBindingModel/GreetingService@_GreetingService_jms_1#-677931704 is stopped, was consuming from: Endpoint[jms://queue:GreetingServiceQueue?connectionFactory=%23ConnectionFactory] 14:09:44,838 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (management-handler-thread - 4) Route: V1CamelJmsBindingModel/GreetingService@_GreetingService_jms_1#-677931704 is shutdown and removed, was consuming from: Endpoint[jms://queue:GreetingServiceQueue?connectionFactory=%23ConnectionFactory] 14:09:46,516 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (management-handler-thread - 1) Route: V1CamelJmsBindingModel/GreetingService@_GreetingService_jms_1#-677931704 started and consuming from: Endpoint[jms://queue:GreetingServiceQueue?connectionFactory=%23ConnectionFactory] 14:09:46,539 INFO [stdout] (pool-8-thread-1) Hello there Stopped :-) 14:09:46,552 INFO [stdout] (pool-8-thread-1) Hello there Restarted :-) 14:09:47,713 INFO [stdout] (pool-8-thread-1) Hello there Tomo :-) 14:09:47,807 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (MSC service thread 1-3) Starting to graceful shutdown 1 routes (timeout 30 seconds) 14:09:48,725 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (Camel (camel-1) thread #1 - ShutdownTask) Route: V1CamelJmsBindingModel/GreetingService@_GreetingService_jms_1#-677931704 shutdown complete, was consuming from: Endpoint[jms://queue:GreetingServiceQueue?connectionFactory=%23ConnectionFactory] 14:09:48,726 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (MSC service thread 1-3) Graceful shutdown of 1 routes completed in 0 seconds 14:09:48,729 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-3) Route: V1CamelJmsBindingModel/GreetingService@_GreetingService_jms_1#-677931704 is stopped, was consuming from: Endpoint[jms://queue:GreetingServiceQueue?connectionFactory=%23ConnectionFactory] 14:09:48,733 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-3) Route: V1CamelJmsBindingModel/GreetingService@_GreetingService_jms_1#-677931704 is shutdown and removed, was consuming from: Endpoint[jms://queue:GreetingServiceQueue?connectionFactory=%23ConnectionFactory] 14:09:48,742 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-3) Apache Camel 2.0.0-SNAPSHOT (CamelContext: camel-1) is shutting down 14:09:48,743 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (MSC service thread 1-3) Starting to graceful shutdown 1 routes (timeout 30 seconds) 14:09:48,745 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (Camel (camel-1) thread #1 - ShutdownTask) Route: direct:{urn:switchyard-quickstart:camel-jms-binding:0.1.0}GreetingService shutdown complete, was consuming from: Endpoint[direct://%7Burn:switchyard-quickstart:camel-jms-binding:0.1.0%7DGreetingService] 14:09:48,746 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (MSC service thread 1-3) Graceful shutdown of 1 routes completed in 0 seconds 14:09:48,781 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-3) Apache Camel 2.0.0-SNAPSHOT (CamelContext: camel-1) uptime 18.307 seconds 14:09:48,782 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-3) Apache Camel 2.0.0-SNAPSHOT (CamelContext: camel-1) is shutdown in 0.039 seconds 14:09:48,785 INFO [org.jboss.weld.deployer] (MSC service thread 1-7) JBAS016009: Stopping weld service for deployment switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar 14:09:48,816 INFO [org.jboss.as.server.deployment] (MSC service thread 1-2) JBAS015877: Stopped deployment switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar (runtime-name: switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar) in 1018ms 14:09:48,852 INFO [org.jboss.as.repository] (management-handler-thread - 2) JBAS014901: Content removed from location <http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws... 14:09:48,853 INFO [org.jboss.as.server] (management-handler-thread - 2) JBAS018558: Undeployed "switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar" (runtime-name: "switchyard-camel-jms-binding-2.0.0-SNAPSHOT.jar") @SLTests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 32.836 sec Running org.switchyard.test.quickstarts.CamelCxfQuickstartTest log4j:WARN No appenders could be found for logger (org.jboss.logging). log4j:WARN Please initialize the log4j system properly. log4j:WARN See http://logging.apache.org/log4j/1.2/faq.html#noconfig for more info. Sep 20, 2014 2:09:52 PM org.jboss.as.arquillian.container.managed.ManagedDeployableContainer startInternal INFO: Starting container with: [/qa/tools/opt/amd64/jdk1.6.0_last/bin/java, -Xms256m, -Xmx1024m, -XX:MaxPermSize=512m, -ea, -Djboss.home.dir=<http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws/jboss-eap-6.3,> -Dorg.jboss.boot.log.file=<http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws/jboss-eap-6.3/standalone/log/boot.log,> -Dlogging.configuration=<http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws/jboss-eap-6.3/standalone/configuration/logging.properties,> -Djboss.bundles.dir=<http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws/jboss-eap-6.3/bundles,> -jar, <http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws... -mp, <http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws... -jaxpmodule, javax.xml.jaxp-provider, org.jboss.as.standalone, -server-config, standalone-full.xml] 14:09:53,264 INFO [org.jboss.modules] (main) JBoss Modules version 1.3.3.Final-redhat-1 14:09:53,814 INFO [org.jboss.msc] (main) JBoss MSC version 1.1.5.Final-redhat-1 14:09:53,983 INFO [org.jboss.as] (MSC service thread 1-6) JBAS015899: JBoss EAP 6.3.0.GA (AS 7.4.0.Final-redhat-19) starting 14:09:56,415 INFO [org.switchyard] (ServerService Thread Pool -- 28) SwitchYard version 2.0.0-SNAPSHOT 14:09:56,839 INFO [org.xnio] (MSC service thread 1-7) XNIO Version 3.0.10.GA-redhat-1 14:09:56,861 INFO [org.jboss.as.server] (Controller Boot Thread) JBAS015888: Creating http management service using socket-binding (management-http) 14:09:56,865 INFO [org.xnio.nio] (MSC service thread 1-7) XNIO NIO Implementation Version 3.0.10.GA-redhat-1 14:09:56,913 INFO [org.jboss.remoting] (MSC service thread 1-7) JBoss Remoting version (unknown) 14:09:56,987 INFO [org.jboss.as.clustering.infinispan] (ServerService Thread Pool -- 36) JBAS010280: Activating Infinispan subsystem. 14:09:57,030 INFO [org.jboss.as.naming] (ServerService Thread Pool -- 48) JBAS011800: Activating Naming Subsystem 14:09:57,040 WARN [org.jboss.as.txn] (ServerService Thread Pool -- 55) JBAS010153: Node identifier property is set to the default value. Please make sure it is unique. 14:09:57,047 INFO [org.jboss.as.jacorb] (ServerService Thread Pool -- 37) JBAS016300: Activating JacORB Subsystem 14:09:57,061 INFO [org.switchyard] (ServerService Thread Pool -- 59) Activating SwitchYard Subsystem 14:09:57,086 INFO [org.jboss.as.jsf] (ServerService Thread Pool -- 44) JBAS012605: Activated the following JSF Implementations: [main, 1.2] 14:09:57,104 INFO [org.jboss.as.security] (ServerService Thread Pool -- 53) JBAS013171: Activating Security Subsystem 14:09:57,149 INFO [org.jboss.as.webservices] (ServerService Thread Pool -- 57) JBAS015537: Activating WebServices Extension 14:09:57,151 INFO [org.jboss.as.security] (MSC service thread 1-7) JBAS013170: Current PicketBox version=4.0.19.SP8-redhat-1 14:09:57,623 INFO [org.jboss.as.connector.logging] (MSC service thread 1-2) JBAS010408: Starting JCA Subsystem (IronJacamar 1.0.26.Final-redhat-1) 14:09:57,687 INFO [org.jboss.as.naming] (MSC service thread 1-7) JBAS011802: Starting Naming Service 14:09:57,691 INFO [org.jboss.as.mail.extension] (MSC service thread 1-1) JBAS015400: Bound mail session [java:jboss/mail/Default] 14:09:57,802 INFO [org.jboss.jaxr] (MSC service thread 1-4) JBAS014000: Started JAXR subsystem, binding JAXR connection factory into JNDI as: java:jboss/jaxr/ConnectionFactory 14:09:58,199 INFO [org.jboss.as.connector.subsystems.datasources] (ServerService Thread Pool -- 32) JBAS010403: Deploying JDBC-compliant driver class org.h2.Driver (version 1.3) 14:09:58,611 INFO [org.apache.coyote.http11.Http11Protocol] (MSC service thread 1-6) JBWEB003001: Coyote HTTP/1.1 initializing on : http-localhost/127.0.0.1:8080 14:09:58,695 INFO [org.apache.coyote.http11.Http11Protocol] (MSC service thread 1-6) JBWEB003000: Coyote HTTP/1.1 starting on: http-localhost/127.0.0.1:8080 14:09:59,215 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221000: live server is starting with configuration HornetQ Configuration (clustered=false,backup=false,sharedStore=true,journalDirectory=<http:/... 14:09:59,229 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221006: Waiting to obtain live lock 14:09:59,532 INFO [org.jboss.as.jacorb] (MSC service thread 1-1) JBAS016330: CORBA ORB Service started 14:09:59,594 INFO [org.jboss.ws.common.management] (MSC service thread 1-8) JBWS022052: Starting JBoss Web Services - Stack CXF Server 4.3.0.Final-redhat-3 14:09:59,776 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221013: Using NIO Journal 14:10:00,346 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221034: Waiting to obtain live lock 14:10:00,347 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221035: Live Server Obtained live lock 14:10:00,413 INFO [org.jboss.as.jacorb] (MSC service thread 1-5) JBAS016328: CORBA Naming Service started 14:10:00,871 INFO [org.switchyard.component.bpel] (MSC service thread 1-4) SWITCHYARD030800: Init BPEL component 14:10:01,064 INFO [org.jboss.as.server.deployment.scanner] (MSC service thread 1-3) JBAS015012: Started FileSystemDeploymentService for directory <http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws... 14:10:01,108 INFO [org.jboss.as.remoting] (MSC service thread 1-4) JBAS017100: Listening on 127.0.0.1:9999 14:10:01,113 INFO [org.jboss.as.remoting] (MSC service thread 1-8) JBAS017100: Listening on 127.0.0.1:4447 14:10:01,317 INFO [org.jboss.as.connector.subsystems.datasources] (MSC service thread 1-6) JBAS010400: Bound data source [java:jboss/datasources/ExampleDS] 14:10:01,942 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221020: Started Netty Acceptor version 3.6.9.Final-redhat-1-4cc400c 127.0.0.1:5445 for CORE protocol 14:10:01,965 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221020: Started Netty Acceptor version 3.6.9.Final-redhat-1-4cc400c 127.0.0.1:5455 for CORE protocol 14:10:01,988 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221007: Server is now live 14:10:01,989 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 60) HQ221001: HornetQ Server version 2.3.20.Final (2.3.20, 123) [27661ed8-40f0-11e4-8801-fb90aaa7d619] 14:10:02,083 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 60) JBAS011601: Bound messaging object to jndi name java:/ConnectionFactory 14:10:02,089 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 74) HQ221003: trying to deploy queue jms.queue.JCAInflowGreetingServiceQueue 14:10:02,240 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 74) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/JCAInflowGreetingServiceQueue 14:10:02,243 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 74) JBAS011601: Bound messaging object to jndi name java:/JCAInflowGreetingServiceQueue 14:10:02,245 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 73) HQ221003: trying to deploy queue jms.queue.DLQ 14:10:02,249 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 73) JBAS011601: Bound messaging object to jndi name java:/jms/queue/DLQ 14:10:02,250 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 72) HQ221003: trying to deploy queue jms.queue.ResultPropQueue 14:10:02,256 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 72) JBAS011601: Bound messaging object to jndi name java:/ResultPropQueue 14:10:02,258 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 72) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/ResultPropQueue 14:10:02,266 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 71) HQ221003: trying to deploy queue jms.queue.StoreResultQueue 14:10:02,272 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 71) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/StoreResultQueue 14:10:02,283 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 71) JBAS011601: Bound messaging object to jndi name java:/StoreResultQueue 14:10:02,285 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 70) HQ221003: trying to deploy queue jms.queue.StoreFaultQueue 14:10:02,291 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 70) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/StoreFaultQueue 14:10:02,293 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 70) JBAS011601: Bound messaging object to jndi name java:/StoreFaultQueue 14:10:02,305 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 69) HQ221003: trying to deploy queue jms.queue.InOutTestQueue_replyTo 14:10:02,310 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 69) JBAS011601: Bound messaging object to jndi name java:/InOutTestQueue_replyTo 14:10:02,312 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 69) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/InOutTestQueue_replyTo 14:10:02,314 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 68) HQ221003: trying to deploy queue jms.queue.NonTransactedTestQueue 14:10:02,320 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 68) JBAS011601: Bound messaging object to jndi name java:/NonTransactedTestQueue 14:10:02,335 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 68) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/NonTransactedTestQueue 14:10:02,337 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 67) HQ221003: trying to deploy queue jms.queue.TestQueue 14:10:02,342 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 67) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/TestQueue 14:10:02,345 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 67) JBAS011601: Bound messaging object to jndi name java:/TestQueue 14:10:02,347 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 66) HQ221003: trying to deploy queue jms.queue.GreetingServiceQueue 14:10:02,352 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 66) JBAS011601: Bound messaging object to jndi name java:/GreetingServiceQueue 14:10:02,355 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 66) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/GreetingServiceQueue 14:10:02,357 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 65) HQ221003: trying to deploy queue jms.queue.InOutTestQueue 14:10:02,363 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 65) JBAS011601: Bound messaging object to jndi name java:/InOutTestQueue 14:10:02,365 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 65) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/InOutTestQueue 14:10:02,367 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 64) HQ221003: trying to deploy queue jms.queue.InOutTestQueue_faultTo 14:10:02,373 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 64) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/InOutTestQueue_faultTo 14:10:02,376 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 64) JBAS011601: Bound messaging object to jndi name java:/InOutTestQueue_faultTo 14:10:02,378 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 62) HQ221003: trying to deploy queue jms.queue.ExpiryQueue 14:10:02,389 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 62) JBAS011601: Bound messaging object to jndi name java:/jms/queue/ExpiryQueue 14:10:02,391 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 63) HQ221003: trying to deploy queue jms.queue.ResultQueue 14:10:02,396 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 63) JBAS011601: Bound messaging object to jndi name java:/ResultQueue 14:10:02,401 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 63) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/ResultQueue 14:10:02,408 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 61) JBAS011601: Bound messaging object to jndi name java:jboss/exported/jms/RemoteConnectionFactory 14:10:02,474 INFO [org.jboss.as.connector.deployment] (MSC service thread 1-2) JBAS010406: Registered connection factory java:/JmsXA 14:10:02,643 INFO [org.hornetq.ra] (MSC service thread 1-2) HornetQ resource adaptor started 14:10:02,646 INFO [org.jboss.as.connector.services.resourceadapters.ResourceAdapterActivatorService$ResourceAdapterActivator] (MSC service thread 1-2) IJ020002: Deployed: file://RaActivatorhornetq-ra 14:10:02,653 INFO [org.jboss.as.connector.deployment] (MSC service thread 1-5) JBAS010401: Bound JCA ConnectionFactory [java:/JmsXA] 14:10:02,876 INFO [org.jboss.as] (Controller Boot Thread) JBAS015961: Http management interface listening on http://127.0.0.1:9990/management 14:10:02,879 INFO [org.jboss.as] (Controller Boot Thread) JBAS015951: Admin console listening on http://127.0.0.1:9990 14:10:02,880 INFO [org.jboss.as] (Controller Boot Thread) JBAS015874: JBoss EAP 6.3.0.GA (AS 7.4.0.Final-redhat-19) started in 10672ms - Started 230 of 267 services (78 services are lazy, passive or on-demand) 14:10:03,318 INFO [org.jboss.as.repository] (management-handler-thread - 4) JBAS014900: Content added at location <http://jenkins.mw.lab.eng.bos.redhat.com/hudson/job/SwitchYard-Release/ws... 14:10:03,361 INFO [org.jboss.as.server.deployment] (MSC service thread 1-1) JBAS015876: Starting deployment of "switchyard-camel-cxf-2.0.0-SNAPSHOT.jar" (runtime-name: "switchyard-camel-cxf-2.0.0-SNAPSHOT.jar") 14:10:03,927 INFO [org.jboss.weld.deployer] (MSC service thread 1-6) JBAS016002: Processing weld deployment switchyard-camel-cxf-2.0.0-SNAPSHOT.jar 14:10:04,077 INFO [org.jboss.weld.deployer] (MSC service thread 1-8) JBAS016005: Starting Services for CDI deployment: switchyard-camel-cxf-2.0.0-SNAPSHOT.jar 14:10:04,190 INFO [org.jboss.weld.Version] (MSC service thread 1-8) WELD-000900 1.1.23 (redhat) 14:10:04,227 INFO [org.switchyard] (MSC service thread 1-8) Deploying SwitchYard application 'switchyard-camel-cxf-2.0.0-SNAPSHOT.jar' 14:10:04,276 INFO [org.jboss.weld.deployer] (MSC service thread 1-2) JBAS016008: Starting weld service for deployment switchyard-camel-cxf-2.0.0-SNAPSHOT.jar 14:10:05,078 INFO [org.switchyard] (MSC service thread 1-1) Starting SwitchYard service 14:10:05,387 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Apache Camel 2.0.0-SNAPSHOT (CamelContext: camel-1) is starting 14:10:05,390 INFO [org.apache.camel.management.ManagedManagementStrategy] (MSC service thread 1-1) JMX is enabled 14:10:06,302 INFO [org.apache.deltaspike.core.util.ProjectStageProducer] (MSC service thread 1-1) Computed the following DeltaSpike ProjectStage: Production 14:10:06,329 INFO [org.apache.camel.impl.converter.DefaultTypeConverter] (MSC service thread 1-1) Loaded 217 type converters 14:10:06,717 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) StreamCaching is not in use. If using streams then its recommended to enable stream caching. See more details at http://camel.apache.org/stream-caching.html 14:10:06,953 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Total 0 routes, of which 0 is started. 14:10:06,955 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Apache Camel 2.0.0-SNAPSHOT (CamelContext: camel-1) started in 1.565 seconds 14:10:07,311 INFO [org.apache.camel.impl.converter.DefaultTypeConverter] (MSC service thread 1-1) Loaded 217 type converters 14:10:11,343 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Route: direct:{urn:switchyard-quickstart:camel-cxf:2.0}Route/WarehouseServiceExternal started and consuming from: Endpoint[direct://%7Burn:switchyard-quickstart:camel-cxf:2.0%7DRoute/WarehouseServiceExternal] 14:10:12,958 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Route: route1 started and consuming from: Endpoint[switchyard://OrderService] 14:10:13,362 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Route: route2 started and consuming from: Endpoint[switchyard://WarehouseService] 14:10:15,987 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Route: direct:{urn:switchyard-quickstart:camel-cxf:2.0}OrderService started and consuming from: Endpoint[direct://%7Burn:switchyard-quickstart:camel-cxf:2.0%7DOrderService] 14:10:16,465 WARN [org.apache.camel.component.cxf.CxfEndpoint] (MSC service thread 1-1) The endpoint/port name of cxf://http://localhost:8082/camel-cxf/order/OrderService?dataFormat=PAYLOAD&setDefaultBus=false&wsdlURL=OrderService.wsdl is empty, cxf will try to load the first one in wsdl for you. 14:10:16,466 WARN [org.apache.camel.component.cxf.CxfEndpoint] (MSC service thread 1-1) The service name of cxf://http://localhost:8082/camel-cxf/order/OrderService?dataFormat=PAYLOAD&setDefaultBus=false&wsdlURL=OrderService.wsdl is empty, cxf will try to load the first one in wsdl for you. 14:10:17,082 INFO [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (MSC service thread 1-1) Creating Service {urn:switchyard-quickstart:camel-cxf:2.0}OrderService from WSDL: OrderService.wsdl 14:10:17,413 INFO [org.apache.cxf.endpoint.ServerImpl] (MSC service thread 1-1) Setting the server's publish address to be http://localhost:8082/camel-cxf/order/OrderService 14:10:17,423 INFO [org.apache.camel.component.cxf.feature.PayLoadDataFormatFeature] (MSC service thread 1-1) Initialized CXF Server: org.apache.cxf.endpoint.ServerImpl@243cfd5a in Payload mode with allow streaming: true 14:10:17,852 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Route: V2CamelCxfBindingModel/OrderService@_OrderService_cxf_1#-648263703 started and consuming from: Endpoint[cxf://http://localhost:8082/camel-cxf/order/OrderService?dataFormat=PAYLOAD&setDefaultBus=false&wsdlURL=OrderService.wsdl] 14:10:20,447 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Route: direct:{urn:switchyard-quickstart:camel-cxf:2.0}WarehouseService started and consuming from: Endpoint[direct://%7Burn:switchyard-quickstart:camel-cxf:2.0%7DWarehouseService] 14:10:20,514 WARN [org.apache.camel.component.cxf.CxfEndpoint] (MSC service thread 1-1) The endpoint/port name of cxf://http://localhost:8083/camel-cxf/warehouse/WarehouseService?dataFormat=PAYLOAD&setDefaultBus=false&wsdlURL=WarehouseService.wsdl is empty, cxf will try to load the first one in wsdl for you. 14:10:20,514 WARN [org.apache.camel.component.cxf.CxfEndpoint] (MSC service thread 1-1) The service name of cxf://http://localhost:8083/camel-cxf/warehouse/WarehouseService?dataFormat=PAYLOAD&setDefaultBus=false&wsdlURL=WarehouseService.wsdl is empty, cxf will try to load the first one in wsdl for you. 14:10:20,563 INFO [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (MSC service thread 1-1) Creating Service {urn:switchyard-quickstart:camel-cxf:2.0}WarehouseService from WSDL: WarehouseService.wsdl 14:10:20,573 INFO [org.apache.cxf.endpoint.ServerImpl] (MSC service thread 1-1) Setting the server's publish address to be http://localhost:8083/camel-cxf/warehouse/WarehouseService 14:10:20,576 INFO [org.apache.camel.component.cxf.feature.PayLoadDataFormatFeature] (MSC service thread 1-1) Initialized CXF Server: org.apache.cxf.endpoint.ServerImpl@4a5ec877 in Payload mode with allow streaming: true 14:10:20,981 INFO [org.switchyard.common.camel.SwitchYardCamelContextImpl] (MSC service thread 1-1) Route: V2CamelCxfBindingModel/WarehouseService@_WarehouseService_cxf_1#1876388767 started and consuming from: Endpoint[cxf://http://localhost:8083/camel-cxf/warehouse/WarehouseService?dataFormat=PAYLOAD&setDefaultBus=false&wsdlURL=WarehouseService.wsdl] 14:10:21,115 INFO [org.jboss.as.server] (management-handler-thread - 4) JBAS018559: Deployed "switchyard-camel-cxf-2.0.0-SNAPSHOT.jar" (runtime-name : "switchyard-camel-cxf-2.0.0-SNAPSHOT.jar") 14:10:27,925 WARN [org.apache.camel.component.cxf.CxfEndpoint] (pool-6-thread-1) The endpoint/port name of cxf://http://localhost:8083/camel-cxf/warehouse/WarehouseService?dataFormat=PAYLOAD&setDefaultBus=false&wsdlURL=WarehouseService.wsdl is empty, cxf will try to load the first one in wsdl for you. 14:10:27,928 WARN [org.apache.camel.component.cxf.CxfEndpoint] (pool-6-thread-1) The service name of cxf://http://localhost:8083/camel-cxf/warehouse/WarehouseService?dataFormat=PAYLOAD&setDefaultBus=false&wsdlURL=WarehouseService.wsdl is empty, cxf will try to load the first one in wsdl for you. 14:10:27,931 INFO [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (pool-6-thread-1) Creating Service {urn:switchyard-quickstart:camel-cxf:2.0}WarehouseService from WSDL: WarehouseService.wsdl 14:10:27,959 INFO [org.apache.camel.component.cxf.feature.PayLoadDataFormatFeature] (pool-6-thread-1) removing the interceptor org.apache.cxf.interceptor.ClientFaultConverter@45937ecf 14:10:27,961 INFO [org.apache.camel.component.cxf.feature.PayLoadDataFormatFeature] (pool-6-thread-1) Initialized CXF Client: org.apache.camel.component.cxf.CxfEndpoint$CamelCxfClientImpl@64c6295a in Payload mode with allow streaming: true 14:10:27,962 INFO [org.apache.camel.component.cxf.feature.PayLoadDataFormatFeature] (pool-6-thread-1) Initialized CXF Client: org.apache.camel.component.cxf.CxfEndpoint$CamelCxfClientImpl@64c6295a in Payload mode with allow streaming: true Build timed out (after 120 minutes). Marking the build as failed. Build was aborted Archiving artifacts 15:56:03,218 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (MSC service thread 1-1) Starting to graceful shutdown 1 routes (timeout 30 seconds) 15:56:03,242 INFO [org.apache.camel.impl.DefaultShutdownStrategy] (Camel (camel-1) thread #1 - ShutdownTask) Waiting as there are still 1 inflight and pending exchanges to complete, timeout in 30 seconds. 15:56:03,252 INFO [org.apache.coyote.http11.Http11Protocol] (MSC service thread 1-3) JBWEB003075: Coyote HTTP/1.1 pausing on: http-localhost/127.0.0.1:8080 15:56:03,256 INFO [org.apache.coyote.http11.Http11Protocol] (MSC service thread 1-3) JBWEB003077: Coyote HTTP/1.1 stopping on : http-localhost/127.0.0.1:8080 Destroying 1 processes Destroying process.. Destroyed 1 processes Recording test results