[jbossts-issues] [JBoss JIRA] (JBTM-2067) WS-BA tests failed because of WS-BA participant race condition

Gytis Trikleris (JIRA) issues at jboss.org
Thu Jan 23 05:44:29 EST 2014


    [ https://issues.jboss.org/browse/JBTM-2067?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel&focusedCommentId=12938185#comment-12938185 ] 

Gytis Trikleris commented on JBTM-2067:
---------------------------------------

(12:38:28) pfrobinson - freenode: you may have already done this, but...
(12:38:31) pfrobinson - freenode: ➜  ~  cat /tmp/out | grep participant_completion
(12:38:31) pfrobinson - freenode: [0m[0m20:52:48,798 INFO  [stdout] (pool-2-thread-3) rule.debug{create counter} : participant_completion.counter.create: 1
(12:38:33) pfrobinson - freenode: [0m[0m20:52:52,015 INFO  [stdout] (default-workqueue-2) rule.debug{close called} : participant_completion.close.waiting
(12:38:34) pfrobinson - freenode: [0m[0m20:52:52,023 INFO  [stdout] (TaskWorker-1) rule.debug{complete called} : participant_completion.counter.decrement
(12:38:35) pfrobinson - freenode: [0m[0m20:52:52,023 INFO  [stdout] (TaskWorker-1) rule.debug{complete called} : participant_completion.called.waking
(12:38:36) pfrobinson - freenode: [0m[0m20:52:52,024 INFO  [stdout] (default-workqueue-2) rule.debug{close called} : participant_completion.close.woken
(12:38:37) pfrobinson - freenode: [0m[0m20:52:52,045 INFO  [stdout] (TaskWorker-1) rule.debug{complete called} : participant_completion.called.donewake
(12:38:53) pfrobinson - freenode: you can cross-refrence that to the byteman script to make sure it bnehaved as expected
                
> WS-BA tests failed because of WS-BA participant race condition
> --------------------------------------------------------------
>
>                 Key: JBTM-2067
>                 URL: https://issues.jboss.org/browse/JBTM-2067
>             Project: JBoss Transaction Manager
>          Issue Type: Bug
>      Security Level: Public(Everyone can see) 
>          Components: XTS
>            Reporter: Gytis Trikleris
>            Assignee: Gytis Trikleris
>            Priority: Minor
>             Fix For: 5.0.0.CR3
>
>
> http://172.17.131.2/view/Narayana+BlackTie/job/narayana-codeCoverage/94
> {code}
> -------------------------------------------------------------------------------
> Test set: com.arjuna.wstx.tests.arq.ba.CloseTest
> -------------------------------------------------------------------------------
> Tests run: 1, Failures: 0, Errors: 1, Skipped: 0, Time elapsed: 4.501 sec <<< FAILURE!
> testClose(com.arjuna.wstx.tests.arq.ba.CloseTest)  Time elapsed: 3.358 sec  <<< ERROR!
> com.arjuna.wst.TransactionRolledBackException: null
> 	at com.arjuna.wst11.stub.BusinessActivityTerminatorStub.close(BusinessActivityTerminatorStub.java:95)
> 	at com.arjuna.mwlabs.wst11.ba.remote.UserBusinessActivityImple.close(UserBusinessActivityImple.java:157)
> 	at com.arjuna.wstx.tests.arq.ba.CloseTest.testClose(CloseTest.java:64)
> {code}
> {code}
> 20:52:48,060 INFO  [org.jboss.as.repository] (management-handler-thread - 7) JBAS014900: Content added at location /home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/standalone/data/content/fd/6a81be14f9e764131bf67a034aa63f0644d81b/content
> 20:52:48,064 INFO  [org.jboss.as.server.deployment] (MSC service thread 1-2) JBAS015876: Starting deployment of "test.war" (runtime-name: "test.war")
> 20:52:48,089 WARN  [org.jboss.as.dependency.private] (MSC service thread 1-2) JBAS018567: Deployment "deployment.test.war" is using a private module ("org.jboss.jts:main") which may be changed or removed in future versions without notice.
> 20:52:48,090 WARN  [org.jboss.as.dependency.private] (MSC service thread 1-2) JBAS018567: Deployment "deployment.test.war" is using a private module ("org.wildfly.security.manager:main") which may be changed or removed in future versions without notice.
> 20:52:48,091 INFO  [org.jboss.weld.deployer] (MSC service thread 1-2) JBAS016002: Processing weld deployment test.war
> 20:52:48,103 INFO  [org.jboss.weld.deployer] (MSC service thread 1-2) JBAS016005: Starting Services for CDI deployment: test.war
> 20:52:48,106 INFO  [org.jboss.as.arquillian] (MSC service thread 1-2) Arquillian deployment detected: ArquillianConfig[service=jboss.arquillian.config."test.war",unit=test.war,tests=[com.arjuna.wstx.tests.arq.ba.CloseTest]]
> 20:52:48,108 INFO  [org.jboss.weld.deployer] (MSC service thread 1-1) JBAS016008: Starting weld service for deployment test.war
> 20:52:48,283 INFO  [org.wildfly.extension.undertow] (MSC service thread 1-1) JBAS017534: Register web context: /test
> 20:52:48,429 INFO  [org.jboss.as.server] (management-handler-thread - 7) JBAS018559: Deployed "test.war" (runtime-name : "test.war")
> 20:52:48,442 INFO  [stdout] (Thread-0) TransformListener() : handling connection on port 9091
> 20:52:48,472 INFO  [stdout] (Thread-0) retransforming org.jboss.jbossts.xts.bytemanSupport.participantCompletion.ParticipantCompletionCoordinatorRules
> 20:52:48,472 INFO  [stdout] (Thread-0) retransforming com.arjuna.wst11.messaging.engines.ParticipantCompletionCoordinatorEngine
> 20:52:48,472 INFO  [stdout] (Thread-0) retransforming com.arjuna.webservices11.wsarjtx.sei.TerminationCoordinatorPortTypeImpl
> 20:52:48,485 INFO  [stdout] (Thread-0) org.jboss.byteman.agent.Transformer : possible trigger for rule create counter in class org.jboss.jbossts.xts.bytemanSupport.participantCompletion.ParticipantCompletionCoordinatorRules
> 20:52:48,486 INFO  [stdout] (Thread-0) RuleTriggerMethodAdapter.injectTriggerPoint : inserting trigger into org.jboss.jbossts.xts.bytemanSupport.participantCompletion.ParticipantCompletionCoordinatorRules.setParticipantCount(java.lang.Integer) void for rule create counter
> 20:52:48,487 INFO  [stdout] (Thread-0) org.jboss.byteman.agent.Transformer : inserted trigger for create counter in class org.jboss.jbossts.xts.bytemanSupport.participantCompletion.ParticipantCompletionCoordinatorRules
> 20:52:48,505 INFO  [stdout] (Thread-0) org.jboss.byteman.agent.Transformer : possible trigger for rule complete called in class com.arjuna.wst11.messaging.engines.ParticipantCompletionCoordinatorEngine
> 20:52:48,509 INFO  [stdout] (Thread-0) RuleTriggerMethodAdapter.injectTriggerPoint : inserting trigger into com.arjuna.wst11.messaging.engines.ParticipantCompletionCoordinatorEngine.completed(org.oasis_open.docs.ws_tx.wsba._2006._06.NotificationType,org.jboss.ws.api.addressing.MAP,com.arjuna.webservices11.wsarj.ArjunaContext) void for rule complete called
> 20:52:48,531 INFO  [stdout] (Thread-0) org.jboss.byteman.agent.Transformer : inserted trigger for complete called in class com.arjuna.wst11.messaging.engines.ParticipantCompletionCoordinatorEngine
> 20:52:48,552 INFO  [stdout] (Thread-0) org.jboss.byteman.agent.Transformer : possible trigger for rule cancel called in class com.arjuna.webservices11.wsarjtx.sei.TerminationCoordinatorPortTypeImpl
> 20:52:48,554 INFO  [stdout] (Thread-0) RuleTriggerMethodAdapter.injectTriggerPoint : inserting trigger into com.arjuna.webservices11.wsarjtx.sei.TerminationCoordinatorPortTypeImpl.cancelOperation(com.arjuna.schemas.ws._2005._10.wsarjtx.NotificationType) void for rule cancel called
> 20:52:48,556 INFO  [stdout] (Thread-0) org.jboss.byteman.agent.Transformer : inserted trigger for cancel called in class com.arjuna.webservices11.wsarjtx.sei.TerminationCoordinatorPortTypeImpl
> 20:52:48,578 INFO  [stdout] (Thread-0) org.jboss.byteman.agent.Transformer : possible trigger for rule close called in class com.arjuna.webservices11.wsarjtx.sei.TerminationCoordinatorPortTypeImpl
> 20:52:48,579 INFO  [stdout] (Thread-0) RuleTriggerMethodAdapter.injectTriggerPoint : inserting trigger into com.arjuna.webservices11.wsarjtx.sei.TerminationCoordinatorPortTypeImpl.closeOperation(com.arjuna.schemas.ws._2005._10.wsarjtx.NotificationType) void for rule close called
> 20:52:48,581 INFO  [stdout] (Thread-0) org.jboss.byteman.agent.Transformer : inserted trigger for close called in class com.arjuna.webservices11.wsarjtx.sei.TerminationCoordinatorPortTypeImpl
> 20:52:48,796 INFO  [stdout] (pool-2-thread-3) Rule.execute called for create counter_3
> 20:52:48,797 INFO  [stdout] (pool-2-thread-3) HelperManager.install for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:48,797 INFO  [stdout] (pool-2-thread-3) calling activated() for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:48,797 INFO  [stdout] (pool-2-thread-3) Default helper activated
> 20:52:48,797 INFO  [stdout] (pool-2-thread-3) calling installed(create counter) for helper classorg.jboss.byteman.rule.helper.Helper
> 20:52:48,797 INFO  [stdout] (pool-2-thread-3) Installed rule using default helper : create counter
> 20:52:48,798 INFO  [stdout] (pool-2-thread-3) create counter execute
> 20:52:48,798 INFO  [stdout] (pool-2-thread-3) rule.debug{create counter} : participant_completion.counter.create: 1
> 20:52:48,799 INFO  [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (pool-2-thread-3) Creating Service {http://docs.oasis-open.org/ws-tx/wscoor/2006/06}ActivationService from WSDL: jar:file:/home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/modules/system/layers/base/org/jboss/xts/main/jbossxts-5.0.0.CR3-SNAPSHOT.jar!/org/oasis_open/docs/ws_tx/wscoor/_2006/_06/wsdl/wscoor-activation-binding.wsdl
> 20:52:48,808 INFO  [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (pool-2-thread-3) Creating Service {http://docs.oasis-open.org/ws-tx/wscoor/2006/06}ActivationService from WSDL: jar:file:/home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/modules/system/layers/base/org/jboss/xts/main/jbossxts-5.0.0.CR3-SNAPSHOT.jar!/org/oasis_open/docs/ws_tx/wscoor/_2006/_06/wsdl/wscoor-activation-binding.wsdl
> 20:52:48,858 INFO  [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (pool-2-thread-3) Creating Service {http://docs.oasis-open.org/ws-tx/wscoor/2006/06}RegistrationService from WSDL: jar:file:/home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/modules/system/layers/base/org/jboss/xts/main/jbossxts-5.0.0.CR3-SNAPSHOT.jar!/org/oasis_open/docs/ws_tx/wscoor/_2006/_06/wsdl/wscoor-registration-binding.wsdl
> 20:52:48,903 WARN  [com.arjuna.wst] (pool-2-thread-3) ARJUNA043225: Could not save recovery state for non-serializable WS-BA participant 1235
> 20:52:48,970 INFO  [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (pool-2-thread-3) Creating Service {http://docs.oasis-open.org/ws-tx/wsba/2006/06}BusinessAgreementWithParticipantCompletionCoordinatorService from WSDL: jar:file:/home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/modules/system/layers/base/org/jboss/xts/main/jbossxts-5.0.0.CR3-SNAPSHOT.jar!/org/oasis_open/docs/ws_tx/wsba/_2006/_06/wsdl/wsba-participant-completion-coordinator-binding.wsdl
> 20:52:49,022 INFO  [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (pool-2-thread-3) Creating Service {http://docs.oasis-open.org/ws-tx/wscoor/2006/06}RegistrationService from WSDL: jar:file:/home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/modules/system/layers/base/org/jboss/xts/main/jbossxts-5.0.0.CR3-SNAPSHOT.jar!/org/oasis_open/docs/ws_tx/wscoor/_2006/_06/wsdl/wscoor-registration-binding.wsdl
> 20:52:49,046 INFO  [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (pool-2-thread-3) Creating Service {http://schemas.arjuna.com/ws/2005/10/wsarjtx}TerminationCoordinatorService from WSDL: jar:file:/home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/modules/system/layers/base/org/jboss/xts/main/jbossxts-5.0.0.CR3-SNAPSHOT.jar!/com/arjuna/schemas/ws/_2005/_10/wsarjtx/wsdl/wsarjtx-termination-coordinator-binding.wsdl
> 20:52:50,925 INFO  [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (Timer-1) Creating Service {http://docs.oasis-open.org/ws-tx/wsba/2006/06}BusinessAgreementWithParticipantCompletionCoordinatorService from WSDL: jar:file:/home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/modules/system/layers/base/org/jboss/xts/main/jbossxts-5.0.0.CR3-SNAPSHOT.jar!/org/oasis_open/docs/ws_tx/wsba/_2006/_06/wsdl/wsba-participant-completion-coordinator-binding.wsdl
> 20:52:52,013 INFO  [stdout] (default-workqueue-2) Rule.execute called for close called_6
> 20:52:52,014 INFO  [stdout] (default-workqueue-2) HelperManager.install for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:52,014 INFO  [stdout] (default-workqueue-2) calling installed(close called) for helper classorg.jboss.byteman.rule.helper.Helper
> 20:52:52,014 INFO  [stdout] (default-workqueue-2) Installed rule using default helper : close called
> 20:52:52,015 INFO  [stdout] (default-workqueue-2) close called execute
> 20:52:52,015 INFO  [stdout] (default-workqueue-2) rule.debug{close called} : participant_completion.close.waiting
> 20:52:52,021 INFO  [stdout] (TaskWorker-1) Rule.execute called for complete called_4
> 20:52:52,021 INFO  [stdout] (TaskWorker-1) HelperManager.install for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:52,022 INFO  [stdout] (TaskWorker-1) calling installed(complete called) for helper classorg.jboss.byteman.rule.helper.Helper
> 20:52:52,022 INFO  [stdout] (TaskWorker-1) Installed rule using default helper : complete called
> 20:52:52,023 INFO  [stdout] (TaskWorker-1) complete called execute
> 20:52:52,023 INFO  [stdout] (TaskWorker-1) rule.debug{complete called} : participant_completion.counter.decrement
> 20:52:52,023 INFO  [stdout] (TaskWorker-1) rule.debug{complete called} : participant_completion.called.waking
> 20:52:52,024 INFO  [stdout] (default-workqueue-2) rule.debug{close called} : participant_completion.close.woken
> 20:52:52,025 WARN  [com.arjuna.mw.wstx] (TaskWorker-2) ARJUNA045062: Coordinator cancelled the activity
> 20:52:52,035 INFO  [org.apache.cxf.service.factory.ReflectionServiceFactoryBean] (TaskWorker-2) Creating Service {http://schemas.arjuna.com/ws/2005/10/wsarjtx}TerminationParticipantService from WSDL: jar:file:/home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/modules/system/layers/base/org/jboss/xts/main/jbossxts-5.0.0.CR3-SNAPSHOT.jar!/com/arjuna/schemas/ws/_2005/_10/wsarjtx/wsdl/wsarjtx-termination-participant-binding.wsdl
> 20:52:52,045 INFO  [stdout] (TaskWorker-1) rule.debug{complete called} : participant_completion.called.donewake
> 20:52:52,046 INFO  [stdout] (TaskWorker-1) Rule.execute called for complete called_4
> 20:52:52,046 INFO  [stdout] (TaskWorker-1) complete called execute
> 20:52:52,053 SEVERE [org.jboss.arquillian.protocol.jmx.JMXTestRunner] (pool-2-thread-3) Failed: com.arjuna.wstx.tests.arq.ba.CloseTest.testClose: com.arjuna.wst.TransactionRolledBackException
> 	at com.arjuna.wst11.stub.BusinessActivityTerminatorStub.close(BusinessActivityTerminatorStub.java:95) [jbossxts-5.0.0.CR3-SNAPSHOT.jar:5.0.0.CR3-SNAPSHOT (revision: a3308)]
> 	at com.arjuna.mwlabs.wst11.ba.remote.UserBusinessActivityImple.close(UserBusinessActivityImple.java:157) [jbossxts-5.0.0.CR3-SNAPSHOT.jar:5.0.0.CR3-SNAPSHOT (revision: a3308)]
> 	at com.arjuna.wstx.tests.arq.ba.CloseTest.testClose(CloseTest.java:64) [classes:]
> 	at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) [rt.jar:1.7.0_45]
> 	at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57) [rt.jar:1.7.0_45]
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_45]
> 	at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_45]
> 	at org.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:47) [arquillian-service:]
> 	at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:12) [arquillian-service:]
> 	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:44) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian$6$1.invoke(Arquillian.java:270) [arquillian-service:]
> 	at org.jboss.arquillian.container.test.impl.execution.LocalTestExecuter.execute(LocalTestExecuter.java:60) [arquillian-service:]
> 	at sun.reflect.GeneratedMethodAccessor71.invoke(Unknown Source) [:1.7.0_45]
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_45]
> 	at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_45]
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.EventContextImpl.invokeObservers(EventContextImpl.java:99) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:81) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.ManagerImpl.fire(ManagerImpl.java:135) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.ManagerImpl.fire(ManagerImpl.java:115) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.EventImpl.fire(EventImpl.java:67) [arquillian-service:]
> 	at org.jboss.arquillian.container.test.impl.execution.ContainerTestExecuter.execute(ContainerTestExecuter.java:38) [arquillian-service:]
> 	at sun.reflect.GeneratedMethodAccessor70.invoke(Unknown Source) [:1.7.0_45]
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_45]
> 	at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_45]
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.EventContextImpl.invokeObservers(EventContextImpl.java:99) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:81) [arquillian-service:]
> 	at org.jboss.arquillian.test.impl.TestContextHandler.createTestContext(TestContextHandler.java:89) [arquillian-service:]
> 	at sun.reflect.GeneratedMethodAccessor53.invoke(Unknown Source) [:1.7.0_45]
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_45]
> 	at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_45]
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:88) [arquillian-service:]
> 	at org.jboss.arquillian.test.impl.TestContextHandler.createClassContext(TestContextHandler.java:75) [arquillian-service:]
> 	at sun.reflect.GeneratedMethodAccessor52.invoke(Unknown Source) [:1.7.0_45]
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_45]
> 	at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_45]
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:88) [arquillian-service:]
> 	at org.jboss.arquillian.test.impl.TestContextHandler.createSuiteContext(TestContextHandler.java:60) [arquillian-service:]
> 	at sun.reflect.GeneratedMethodAccessor51.invoke(Unknown Source) [:1.7.0_45]
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_45]
> 	at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_45]
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:88) [arquillian-service:]
> 	at org.jboss.arquillian.core.impl.ManagerImpl.fire(ManagerImpl.java:135) [arquillian-service:]
> 	at org.jboss.arquillian.test.impl.EventTestRunnerAdaptor.test(EventTestRunnerAdaptor.java:111) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian$6.evaluate(Arquillian.java:263) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian$4.evaluate(Arquillian.java:226) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian.multiExecute(Arquillian.java:314) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian.access$100(Arquillian.java:46) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian$5.evaluate(Arquillian.java:240) [arquillian-service:]
> 	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:271) [arquillian-service:]
> 	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:70) [arquillian-service:]
> 	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50) [arquillian-service:]
> 	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238) [arquillian-service:]
> 	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63) [arquillian-service:]
> 	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236) [arquillian-service:]
> 	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53) [arquillian-service:]
> 	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian$2.evaluate(Arquillian.java:185) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian.multiExecute(Arquillian.java:314) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian.access$100(Arquillian.java:46) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian$3.evaluate(Arquillian.java:199) [arquillian-service:]
> 	at org.junit.runners.ParentRunner.run(ParentRunner.java:309) [arquillian-service:]
> 	at org.jboss.arquillian.junit.Arquillian.run(Arquillian.java:147) [arquillian-service:]
> 	at org.junit.runner.JUnitCore.run(JUnitCore.java:160) [arquillian-service:]
> 	at org.junit.runner.JUnitCore.run(JUnitCore.java:138) [arquillian-service:]
> 	at org.jboss.arquillian.junit.container.JUnitTestRunner.execute(JUnitTestRunner.java:65) [arquillian-service:]
> 	at org.jboss.arquillian.protocol.jmx.JMXTestRunner.runTestMethodInternal(JMXTestRunner.java:129) [arquillian-service:]
> 	at org.jboss.arquillian.protocol.jmx.JMXTestRunner.runTestMethod(JMXTestRunner.java:108) [arquillian-service:]
> 	at org.jboss.as.arquillian.service.ArquillianService$ExtendedJMXTestRunner.runTestMethod(ArquillianService.java:212) [arquillian-service:]
> 	at sun.reflect.GeneratedMethodAccessor62.invoke(Unknown Source) [:1.7.0_45]
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_45]
> 	at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_45]
> 	at sun.reflect.misc.Trampoline.invoke(MethodUtil.java:75) [rt.jar:1.7.0_45]
> 	at sun.reflect.GeneratedMethodAccessor56.invoke(Unknown Source) [:1.7.0_45]
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_45]
> 	at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_45]
> 	at sun.reflect.misc.MethodUtil.invoke(MethodUtil.java:279) [rt.jar:1.7.0_45]
> 	at com.sun.jmx.mbeanserver.StandardMBeanIntrospector.invokeM2(StandardMBeanIntrospector.java:112) [rt.jar:1.7.0_45]
> 	at com.sun.jmx.mbeanserver.StandardMBeanIntrospector.invokeM2(StandardMBeanIntrospector.java:46) [rt.jar:1.7.0_45]
> 	at com.sun.jmx.mbeanserver.MBeanIntrospector.invokeM(MBeanIntrospector.java:237) [rt.jar:1.7.0_45]
> 	at com.sun.jmx.mbeanserver.PerInterface.invoke(PerInterface.java:138) [rt.jar:1.7.0_45]
> 	at com.sun.jmx.mbeanserver.MBeanSupport.invoke(MBeanSupport.java:252) [rt.jar:1.7.0_45]
> 	at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.invoke(DefaultMBeanServerInterceptor.java:819) [rt.jar:1.7.0_45]
> 	at com.sun.jmx.mbeanserver.JmxMBeanServer.invoke(JmxMBeanServer.java:801) [rt.jar:1.7.0_45]
> 	at org.jboss.as.jmx.PluggableMBeanServerImpl$TcclMBeanServer.invoke(PluggableMBeanServerImpl.java:1454)
> 	at org.jboss.as.jmx.PluggableMBeanServerImpl.invoke(PluggableMBeanServerImpl.java:732)
> 	at org.jboss.remotingjmx.protocol.v2.ServerProxy$InvokeHandler.handle(ServerProxy.java:952)
> 	at org.jboss.remotingjmx.protocol.v2.ServerCommon$MessageReciever$1$1.run(ServerCommon.java:153)
> 	at org.jboss.as.jmx.ServerInterceptorFactory$Interceptor$1.run(ServerInterceptorFactory.java:75)
> 	at org.jboss.as.jmx.ServerInterceptorFactory$Interceptor$1.run(ServerInterceptorFactory.java:70)
> 	at java.security.AccessController.doPrivileged(Native Method) [rt.jar:1.7.0_45]
> 	at javax.security.auth.Subject.doAs(Subject.java:415) [rt.jar:1.7.0_45]
> 	at org.jboss.as.controller.AccessAuditContext.doAs(AccessAuditContext.java:94)
> 	at org.jboss.as.jmx.ServerInterceptorFactory$Interceptor.handleEvent(ServerInterceptorFactory.java:70)
> 	at org.jboss.remotingjmx.protocol.v2.ServerCommon$MessageReciever$1.run(ServerCommon.java:149)
> 	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1145) [rt.jar:1.7.0_45]
> 	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615) [rt.jar:1.7.0_45]
> 	at java.lang.Thread.run(Thread.java:744) [rt.jar:1.7.0_45]
> Jan 03, 2014 8:52:52 PM org.jboss.arquillian.protocol.jmx.JMXMethodExecutor invoke
> SEVERE: Failed: com.arjuna.wstx.tests.arq.ba.CloseTest.testClose
> com.arjuna.wst.TransactionRolledBackException
> 	at com.arjuna.wst11.stub.BusinessActivityTerminatorStub.close(BusinessActivityTerminatorStub.java:95)
> 	at com.arjuna.mwlabs.wst11.ba.remote.UserBusinessActivityImple.close(UserBusinessActivityImple.java:157)
> 	at com.arjuna.wstx.tests.arq.ba.CloseTest.testClose(CloseTest.java:64)
> 	at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
> 	at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
> 	at java.lang.reflect.Method.invoke(Method.java:606)
> 	at org.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:47)
> 	at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:12)
> 	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:44)
> 	at org.jboss.arquillian.junit.Arquillian$6$1.invoke(Arquillian.java:270)
> 	at org.jboss.arquillian.container.test.impl.execution.LocalTestExecuter.execute(LocalTestExecuter.java:60)
> 	at sun.reflect.GeneratedMethodAccessor71.invoke(Unknown Source)
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
> 	at java.lang.reflect.Method.invoke(Method.java:606)
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94)
> 	at org.jboss.arquillian.core.impl.EventContextImpl.invokeObservers(EventContextImpl.java:99)
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:81)
> 	at org.jboss.arquillian.core.impl.ManagerImpl.fire(ManagerImpl.java:135)
> 	at org.jboss.arquillian.core.impl.ManagerImpl.fire(ManagerImpl.java:115)
> 	at org.jboss.arquillian.core.impl.EventImpl.fire(EventImpl.java:67)
> 	at org.jboss.arquillian.container.test.impl.execution.ContainerTestExecuter.execute(ContainerTestExecuter.java:38)
> 	at sun.reflect.GeneratedMethodAccessor70.invoke(Unknown Source)
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
> 	at java.lang.reflect.Method.invoke(Method.java:606)
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94)
> 	at org.jboss.arquillian.core.impl.EventContextImpl.invokeObservers(EventContextImpl.java:99)
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:81)
> 	at org.jboss.arquillian.test.impl.TestContextHandler.createTestContext(TestContextHandler.java:89)
> 	at sun.reflect.GeneratedMethodAccessor53.invoke(Unknown Source)
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
> 	at java.lang.reflect.Method.invoke(Method.java:606)
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94)
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:88)
> 	at org.jboss.arquillian.test.impl.TestContextHandler.createClassContext(TestContextHandler.java:75)
> 	at sun.reflect.GeneratedMethodAccessor52.invoke(Unknown Source)
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
> 	at java.lang.reflect.Method.invoke(Method.java:606)
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94)
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:88)
> 	at org.jboss.arquillian.test.impl.TestContextHandler.createSuiteContext(TestContextHandler.java:60)
> 	at sun.reflect.GeneratedMethodAccessor51.invoke(Unknown Source)
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
> 	at java.lang.reflect.Method.invoke(Method.java:606)
> 	at org.jboss.arquillian.core.impl.ObserverImpl.invoke(ObserverImpl.java:94)
> 	at org.jboss.arquillian.core.impl.EventContextImpl.proceed(EventContextImpl.java:88)
> 	at org.jboss.arquillian.core.impl.ManagerImpl.fire(ManagerImpl.java:135)
> 	at org.jboss.arquillian.test.impl.EventTestRunnerAdaptor.test(EventTestRunnerAdaptor.java:111)
> 	at org.jboss.arquillian.junit.Arquillian$6.evaluate(Arquillian.java:263)
> 	at org.jboss.arquillian.junit.Arquillian$4.evaluate(Arquillian.java:226)
> 	at org.jboss.arquillian.junit.Arquillian.multiExecute(Arquillian.java:314)
> 	at org.jboss.arquillian.junit.Arquillian.access$100(Arquillian.java:46)
> 	at org.jboss.arquillian.junit.Arquillian$5.evaluate(Arquillian.java:240)
> 	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:271)
> 	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:70)
> 	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50)
> 	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
> 	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
> 	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
> 	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
> 	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
> 	at org.jboss.arquillian.junit.Arquillian$2.evaluate(Arquillian.java:185)
> 	at org.jboss.arquillian.junit.Arquillian.multiExecute(Arquillian.java:314)
> 	at org.jboss.arquillian.junit.Arquillian.access$100(Arquillian.java:46)
> 	at org.jboss.arquillian.junit.Arquillian$3.evaluate(Arquillian.java:199)
> 	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
> 	at org.jboss.arquillian.junit.Arquillian.run(Arquillian.java:147)
> 	at org.junit.runner.JUnitCore.run(JUnitCore.java:160)
> 	at org.junit.runner.JUnitCore.run(JUnitCore.java:138)
> 	at org.jboss.arquillian.junit.container.JUnitTestRunner.execute(JUnitTestRunner.java:65)
> 	at org.jboss.arquillian.protocol.jmx.JMXTestRunner.runTestMethodInternal(JMXTestRunner.java:129)
> 	at org.jboss.arquillian.protocol.jmx.JMXTestRunner.runTestMethod(JMXTestRunner.java:108)
> 	at org.jboss.as.arquillian.service.ArquillianService$ExtendedJMXTestRunner.runTestMethod(ArquillianService.java:212)
> 	at sun.reflect.GeneratedMethodAccessor62.invoke(Unknown Source)
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
> 	at java.lang.reflect.Method.invoke(Method.java:606)
> 	at sun.reflect.misc.Trampoline.invoke(MethodUtil.java:75)
> 	at sun.reflect.GeneratedMethodAccessor56.invoke(Unknown Source)
> 	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
> 	at java.lang.reflect.Method.invoke(Method.java:606)
> 	at sun.reflect.misc.MethodUtil.invoke(MethodUtil.java:279)
> 	at com.sun.jmx.mbeanserver.StandardMBeanIntrospector.invokeM2(StandardMBeanIntrospector.java:112)
> 	at com.sun.jmx.mbeanserver.StandardMBeanIntrospector.invokeM2(StandardMBeanIntrospector.java:46)
> 	at com.sun.jmx.mbeanserver.MBeanIntrospector.invokeM(MBeanIntrospector.java:237)
> 	at com.sun.jmx.mbeanserver.PerInterface.invoke(PerInterface.java:138)
> 	at com.sun.jmx.mbeanserver.MBeanSupport.invoke(MBeanSupport.java:252)
> 	at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.invoke(DefaultMBeanServerInterceptor.java:819)
> 	at com.sun.jmx.mbeanserver.JmxMBeanServer.invoke(JmxMBeanServer.java:801)
> 	at org.jboss.as.jmx.PluggableMBeanServerImpl$TcclMBeanServer.invoke(PluggableMBeanServerImpl.java:1454)
> 	at org.jboss.as.jmx.PluggableMBeanServerImpl.invoke(PluggableMBeanServerImpl.java:732)
> 	at org.jboss.remotingjmx.protocol.v2.ServerProxy$InvokeHandler.handle(ServerProxy.java:952)
> 	at org.jboss.remotingjmx.protocol.v2.ServerCommon$MessageReciever$1$1.run(ServerCommon.java:153)
> 	at org.jboss.as.jmx.ServerInterceptorFactory$Interceptor$1.run(ServerInterceptorFactory.java:75)
> 	at org.jboss.as.jmx.ServerInterceptorFactory$Interceptor$1.run(ServerInterceptorFactory.java:70)
> 	at java.security.AccessController.doPrivileged(Native Method)
> 	at javax.security.auth.Subject.doAs(Subject.java:415)
> 	at org.jboss.as.controller.AccessAuditContext.doAs(AccessAuditContext.java:94)
> 	at org.jboss.as.jmx.ServerInterceptorFactory$Interceptor.handleEvent(ServerInterceptorFactory.java:70)
> 	at org.jboss.remotingjmx.protocol.v2.ServerCommon$MessageReciever$1.run(ServerCommon.java:149)
> 	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1145)
> 	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
> 	at java.lang.Thread.run(Thread.java:744)
> 20:52:52,182 INFO  [stdout] (Thread-0) TransformListener() : handling connection on port 9091
> 20:52:52,256 INFO  [stdout] (Thread-0) retransforming org.jboss.jbossts.xts.bytemanSupport.participantCompletion.ParticipantCompletionCoordinatorRules
> 20:52:52,256 INFO  [stdout] (Thread-0) retransforming com.arjuna.wst11.messaging.engines.ParticipantCompletionCoordinatorEngine
> 20:52:52,257 INFO  [stdout] (Thread-0) retransforming com.arjuna.webservices11.wsarjtx.sei.TerminationCoordinatorPortTypeImpl
> 20:52:52,385 INFO  [stdout] (Thread-0) HelperManager.uninstall for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:52,386 INFO  [stdout] (Thread-0) calling uninstalled(create counter) for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:52,387 INFO  [stdout] (Thread-0) Uninstalled rule using default helper : create counter
> 20:52:52,387 INFO  [stdout] (Thread-0) HelperManager.uninstall for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:52,387 INFO  [stdout] (Thread-0) calling uninstalled(complete called) for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:52,388 INFO  [stdout] (Thread-0) Uninstalled rule using default helper : complete called
> 20:52:52,388 INFO  [stdout] (Thread-0) HelperManager.uninstall for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:52,388 INFO  [stdout] (Thread-0) calling uninstalled(close called) for helper class org.jboss.byteman.rule.helper.Helper
> 20:52:52,389 INFO  [stdout] (Thread-0) Uninstalled rule using default helper : close called
> 20:52:52,389 INFO  [stdout] (Thread-0) calling deactivated() for helper classorg.jboss.byteman.rule.helper.Helper
> 20:52:52,389 INFO  [stdout] (Thread-0) Default helper deactivated
> 20:52:52,398 INFO  [org.wildfly.extension.undertow] (MSC service thread 1-2) JBAS017535: Unregister web context: /test
> 20:52:52,411 INFO  [org.jboss.weld.deployer] (MSC service thread 1-2) JBAS016009: Stopping weld service for deployment test.war
> 20:52:52,417 INFO  [org.jboss.as.server.deployment] (MSC service thread 1-2) JBAS015877: Stopped deployment test.war (runtime-name: test.war) in 20ms
> 20:52:52,504 INFO  [org.jboss.as.repository] (management-handler-thread - 5) JBAS014901: Content removed from location /home/hudson/workspace/narayana-codeCoverage/jboss-as/build/target/wildfly-8.0.0.Final-SNAPSHOT/standalone/data/content/fd/6a81be14f9e764131bf67a034aa63f0644d81b/content
> 20:52:52,505 INFO  [org.jboss.as.server] (management-handler-thread - 5) JBAS018558: Undeployed "test.war" (runtime-name: "test.war")
> 
> {code}

--
This message is automatically generated by JIRA.
If you think it was sent incorrectly, please contact your JIRA administrators
For more information on JIRA, see: http://www.atlassian.com/software/jira



More information about the jbossts-issues mailing list