ListServersStatusTest failed ---------------------------- Key: JBTM-1994 URL: https://issues.jboss.org/browse/JBTM-1994 Project: JBoss Transaction Manager Issue Type: Bug Security Level: Public(Everyone can see) Components: BlackTie Reporter: Gytis Trikleris Assignee: Amos Feng Priority: Minor Fix For: 5.0.0.M9 Failed tests: testListServersStatusTestWithServers(org.jboss.narayana.blacktie.btadmin.ListServersStatusTest): Command failed {code} Running org.jboss.narayana.blacktie.btadmin.ListServersStatusTest 17:10:08,439 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 91) HQ221003: trying to deploy queue jms.queue.BTR_.testsui1 17:10:08,440 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 91) JBAS011601: Bound messaging object to jndi name /queue/BTR_.testsui1 17:10:10,359 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 91) HQ221003: trying to deploy queue jms.queue.BTR_.testsui2 17:10:10,360 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 91) JBAS011601: Bound messaging object to jndi name /queue/BTR_.testsui2 17:10:14,122 INFO [org.hornetq.core.server] (ServerService Thread Pool -- 91) HQ221003: trying to deploy queue jms.queue.BTR_BAR 17:10:14,123 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 91) JBAS011601: Bound messaging object to jndi name /queue/BTR_BAR 17:10:14,315 ERROR [stderr] (Thread-996) Exception in thread "Thread-996" java.lang.NumberFormatException: For input string: "e1" 17:10:14,316 ERROR [stderr] (Thread-996) at java.lang.NumberFormatException.forInputString(NumberFormatException.java:65) 17:10:14,316 ERROR [stderr] (Thread-996) at java.lang.Integer.parseInt(Integer.java:492) 17:10:14,317 ERROR [stderr] (Thread-996) at java.lang.Integer.parseInt(Integer.java:527) 17:10:14,317 ERROR [stderr] (Thread-996) at org.jboss.narayana.blacktie.jatmibroker.core.server.Client.run(SocketServer.java:266) 17:10:14,318 ERROR [stderr] (Thread-996) at java.lang.Thread.run(Thread.java:722) 17:10:14,344 ERROR [org.codehaus.stomp.tcp.TcpTransport] (StompConnect Transport: tcp:///127.0.0.1:39767) Caught an exception: Connection reset: java.net.SocketException: Connection reset at java.net.SocketInputStream.read(SocketInputStream.java:189) [rt.jar:1.7.0_17] at java.net.SocketInputStream.read(SocketInputStream.java:121) [rt.jar:1.7.0_17] at java.net.SocketInputStream.read(SocketInputStream.java:203) [rt.jar:1.7.0_17] at java.io.DataInputStream.readByte(DataInputStream.java:265) [rt.jar:1.7.0_17] at org.codehaus.stomp.StompMarshaller.readLine(StompMarshaller.java:183) [wildfly-blacktie-8.0.0.Beta2-SNAPSHOT.jar:8.0.0.Beta2-SNAPSHOT] at org.codehaus.stomp.StompMarshaller.unmarshal(StompMarshaller.java:94) [wildfly-blacktie-8.0.0.Beta2-SNAPSHOT.jar:8.0.0.Beta2-SNAPSHOT] at org.codehaus.stomp.tcp.TcpTransport.run(TcpTransport.java:98) [wildfly-blacktie-8.0.0.Beta2-SNAPSHOT.jar:8.0.0.Beta2-SNAPSHOT] at java.lang.Thread.run(Thread.java:722) [rt.jar:1.7.0_17] 17:10:15,219 WARN [org.jboss.narayana.blacktie.administration.QueueReaperBean] (EJB default - 5) undeploy service pending for .testsui2 as consumer count is 0, will check again in 30000ms 17:10:46,379 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 92) JBAS011605: Unbound messaging object to jndi name java:/queue/BTR_.testsui2 17:10:46,498 WARN [org.jboss.narayana.blacktie.administration.QueueReaperBean] (EJB default - 5) undeploy service .testsui2 for consumer is 0 17:11:00,632 INFO [org.jboss.narayana.blacktie.administration.BlacktieAdminServiceXATMI] (Thread-30 (HornetQ-client-global-threads-802859)) init PostConstruct 17:11:00,634 INFO [org.jboss.narayana.blacktie.administration.core.AdministrationProxy] (Thread-30 (HornetQ-client-global-threads-802859)) onConstruct load btconfig.xml 17:11:01,914 ERROR [org.jboss.narayana.blacktie.administration.core.AdministrationProxy] (Thread-31 (HornetQ-client-global-threads-802859)) call server testsui id 2 command advertise,BAR, failed with 13 17:11:01,914 WARN [org.jboss.narayana.blacktie.administration.core.AdministrationProxy] (Thread-31 (HornetQ-client-global-threads-802859)) Failed to advertise service: BAR at: testsui2 17:11:07,694 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 93) JBAS011605: Unbound messaging object to jndi name java:/queue/BTR_BAR 17:11:09,581 INFO [org.jboss.as.messaging] (ServerService Thread Pool -- 93) JBAS011605: Unbound messaging object to jndi name java:/queue/BTR_.testsui1 Tests run: 3, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: 66.607 sec <<< FAILURE! testListServersStatusTestWithServers(org.jboss.narayana.blacktie.btadmin.ListServersStatusTest) Time elapsed: 65.274 sec <<< FAILURE! junit.framework.AssertionFailedError: Command failed at junit.framework.Assert.fail(Assert.java:50) at org.jboss.narayana.blacktie.btadmin.ListServersStatusTest.testListServersStatusTestWithServers(ListServersStatusTest.java:80) 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:601) at junit.framework.TestCase.runTest(TestCase.java:168) at junit.framework.TestCase.runBare(TestCase.java:134) at junit.framework.TestResult$1.protect(TestResult.java:110) at junit.framework.TestResult.runProtected(TestResult.java:128) at junit.framework.TestResult.run(TestResult.java:113) at junit.framework.TestCase.run(TestCase.java:124) at junit.framework.TestSuite.runTest(TestSuite.java:243) at junit.framework.TestSuite.run(TestSuite.java:238) at org.junit.internal.runners.JUnit38ClassRunner.run(JUnit38ClassRunner.java:83) at org.apache.maven.surefire.junit4.JUnit4Provider.execute(JUnit4Provider.java:252) at org.apache.maven.surefire.junit4.JUnit4Provider.executeTestSet(JUnit4Provider.java:141) at org.apache.maven.surefire.junit4.JUnit4Provider.invoke(JUnit4Provider.java:112) 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:601) at org.apache.maven.surefire.util.ReflectionUtils.invokeMethodWithArray(ReflectionUtils.java:189) at org.apache.maven.surefire.booter.ProviderFactory$ProviderProxy.invoke(ProviderFactory.java:165) at org.apache.maven.surefire.booter.ProviderFactory.invokeProvider(ProviderFactory.java:85) at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:115) at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:75) {code} {code} 2013-10-17 17:10:05,740 [main] INFO (min.ListServersStatusTest:54 ) - ListServersStatusTest::testListServersStatusTestWithAdditionalArgs 2013-10-17 17:10:05,741 [main] ERROR (btadmin.CommandHandler :109 ) - Expected Usage: listServersStatus 2013-10-17 17:10:05,742 [main] INFO (min.ListServersStatusTest:41 ) - ListServersStatusTest::tearDown 2013-10-17 17:10:05,743 [main] INFO (min.ListServersStatusTest:63 ) - ListServersStatusTest::testListServersStatusTestWithoutServers 2013-10-17 17:10:07,072 [main] INFO (mmands.ListRunningServers:55 ) - Output from: listRunningServers 2013-10-17 17:10:07,072 [main] INFO (min.ListServersStatusTest:41 ) - ListServersStatusTest::tearDown 2013-10-17 17:10:07,073 [main] INFO (min.ListServersStatusTest:72 ) - ListServersStatusTest::testListServersStatusTestWithServers 2013-10-17 17:10:07,075 [main] INFO (conf.Server :51 ) - Checking for host: tenafly.buildnet.ncl.jboss.com or ip: 172.17.131.20 2013-10-17 17:10:08,587 [main] INFO (commands.Startup :111 ) - 2013-10-17 17:10:08,587 [0xb777c710] INFO (AtmiBrokerServer :938 ) - advertised service .testsui1 2013-10-17 17:10:08,588 [main] INFO (commands.Startup :111 ) - 2013-10-17 17:10:08,588 [0xb777c710] INFO (AtmiBrokerServer :243 ) - Server 1 Running 2013-10-17 17:10:08,588 [main] INFO (commands.Startup :111 ) - 2013-10-17 17:10:08,588 [0xb777c710] INFO (AtmiBrokerServer :645 ) - Server waiting for requests... 2013-10-17 17:10:10,521 [main] INFO (commands.Startup :111 ) - 2013-10-17 17:10:10,521 [0xb7790710] INFO (AtmiBrokerServer :938 ) - advertised service .testsui2 2013-10-17 17:10:10,522 [main] INFO (commands.Startup :111 ) - 2013-10-17 17:10:10,522 [0xb7790710] INFO (AtmiBrokerServer :243 ) - Server 2 Running 2013-10-17 17:10:10,522 [main] INFO (commands.Startup :111 ) - 2013-10-17 17:10:10,522 [0xb7790710] INFO (AtmiBrokerServer :645 ) - Server waiting for requests... 2013-10-17 17:10:10,524 [main] INFO (min.ListServersStatusTest:77 ) - Started 2013-10-17 17:11:00,577 [main] ERROR (btadmin.CommandHandler :123 ) - Could not invoke the command: null java.lang.reflect.UndeclaredThrowableException at com.sun.proxy.$Proxy0.advertise(Unknown Source) at org.jboss.narayana.blacktie.btadmin.commands.Advertise.invoke(Advertise.java:61) at org.jboss.narayana.blacktie.btadmin.CommandHandler.handleCommand(CommandHandler.java:117) at org.jboss.narayana.blacktie.btadmin.ListServersStatusTest.testListServersStatusTestWithServers(ListServersStatusTest.java:79) 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:601) at junit.framework.TestCase.runTest(TestCase.java:168) at junit.framework.TestCase.runBare(TestCase.java:134) at junit.framework.TestResult$1.protect(TestResult.java:110) at junit.framework.TestResult.runProtected(TestResult.java:128) at junit.framework.TestResult.run(TestResult.java:113) at junit.framework.TestCase.run(TestCase.java:124) at junit.framework.TestSuite.runTest(TestSuite.java:243) at junit.framework.TestSuite.run(TestSuite.java:238) at org.junit.internal.runners.JUnit38ClassRunner.run(JUnit38ClassRunner.java:83) at org.apache.maven.surefire.junit4.JUnit4Provider.execute(JUnit4Provider.java:252) at org.apache.maven.surefire.junit4.JUnit4Provider.executeTestSet(JUnit4Provider.java:141) at org.apache.maven.surefire.junit4.JUnit4Provider.invoke(JUnit4Provider.java:112) 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:601) at org.apache.maven.surefire.util.ReflectionUtils.invokeMethodWithArray(ReflectionUtils.java:189) at org.apache.maven.surefire.booter.ProviderFactory$ProviderProxy.invoke(ProviderFactory.java:165) at org.apache.maven.surefire.booter.ProviderFactory.invokeProvider(ProviderFactory.java:85) at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:115) at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:75) Caused by: org.jboss.narayana.blacktie.jatmibroker.xatmi.ConnectionException: tperrno: 13 reason: Did not receive a message at org.jboss.narayana.blacktie.jatmibroker.core.transport.hybrid.SocketReceiverImpl.receive(SocketReceiverImpl.java:139) at org.jboss.narayana.blacktie.jatmibroker.xatmi.impl.ConnectionImpl.receive(ConnectionImpl.java:535) at org.jboss.narayana.blacktie.jatmibroker.xatmi.impl.ConnectionImpl.tpcall(ConnectionImpl.java:185) at org.jboss.narayana.blacktie.btadmin.CommandHandler.invoke(CommandHandler.java:187) ... 29 more 2013-10-17 17:11:00,583 [main] INFO (min.ListServersStatusTest:41 ) - ListServersStatusTest::tearDown 2013-10-17 17:11:12,327 [main] INFO (commands.Shutdown :126 ) - Server shutdown successfully: testsui with id: 0 2013-10-17 17:11:12,328 [main] INFO (commands.Shutdown :127 ) - waiting for testsui:0 shutdown complete 2013-10-17 17:11:12,343 [main] INFO (commands.Shutdown :135 ) - testsui:0 shutdown complete {code}