You are viewing a plain text version of this content. The canonical link for it is here.
Posted to dev@zookeeper.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2013/12/20 01:47:58 UTC

ZooKeeper_branch34_openjdk7 - Build # 410 - Failure

See https://builds.apache.org/job/ZooKeeper_branch34_openjdk7/410/

###################################################################################
########################## LAST 60 LINES OF THE CONSOLE ###########################
[...truncated 200039 lines...]
    [junit] 2013-12-20 00:47:51,118 [myid:] - INFO  [main:JMXEnv@105] - expect:StandaloneServer_port
    [junit] 2013-12-20 00:47:51,118 [myid:] - INFO  [main:JMXEnv@108] - found:StandaloneServer_port org.apache.ZooKeeperService:name0=StandaloneServer_port-1
    [junit] 2013-12-20 00:47:51,119 [myid:] - INFO  [main:ClientBase@420] - STOPPING server
    [junit] 2013-12-20 00:47:51,119 [myid:] - INFO  [NIOServerCxn.Factory:0.0.0.0/0.0.0.0:11221:NIOServerCnxnFactory@224] - NIOServerCnxn factory exited run method
    [junit] 2013-12-20 00:47:51,119 [myid:] - INFO  [main:ZooKeeperServer@441] - shutting down
    [junit] 2013-12-20 00:47:51,119 [myid:] - INFO  [main:SessionTrackerImpl@225] - Shutting down
    [junit] 2013-12-20 00:47:51,120 [myid:] - INFO  [main:PrepRequestProcessor@761] - Shutting down
    [junit] 2013-12-20 00:47:51,120 [myid:] - INFO  [main:SyncRequestProcessor@209] - Shutting down
    [junit] 2013-12-20 00:47:51,120 [myid:] - INFO  [ProcessThread(sid:0 cport:-1)::PrepRequestProcessor@143] - PrepRequestProcessor exited loop!
    [junit] 2013-12-20 00:47:51,120 [myid:] - INFO  [SyncThread:0:SyncRequestProcessor@187] - SyncRequestProcessor exited!
    [junit] 2013-12-20 00:47:51,120 [myid:] - INFO  [main:FinalRequestProcessor@415] - shutdown of request processor complete
    [junit] 2013-12-20 00:47:51,121 [myid:] - INFO  [main:FourLetterWordMain@43] - connecting to 127.0.0.1 11221
    [junit] 2013-12-20 00:47:51,121 [myid:] - INFO  [main:JMXEnv@135] - ensureOnly:[]
    [junit] 2013-12-20 00:47:51,123 [myid:] - INFO  [main:ClientBase@413] - STARTING server
    [junit] 2013-12-20 00:47:51,123 [myid:] - INFO  [main:ZooKeeperServer@162] - Created server with tickTime 3000 minSessionTimeout 6000 maxSessionTimeout 60000 datadir /home/jenkins/jenkins-slave/workspace/ZooKeeper_branch34_openjdk7/branch-3.4/build/test/tmp/test1070291047967627312.junit.dir/version-2 snapdir /home/jenkins/jenkins-slave/workspace/ZooKeeper_branch34_openjdk7/branch-3.4/build/test/tmp/test1070291047967627312.junit.dir/version-2
    [junit] 2013-12-20 00:47:51,123 [myid:] - INFO  [main:NIOServerCnxnFactory@94] - binding to port 0.0.0.0/0.0.0.0:11221
    [junit] 2013-12-20 00:47:51,127 [myid:] - INFO  [main:FourLetterWordMain@43] - connecting to 127.0.0.1 11221
    [junit] 2013-12-20 00:47:51,128 [myid:] - INFO  [NIOServerCxn.Factory:0.0.0.0/0.0.0.0:11221:NIOServerCnxnFactory@197] - Accepted socket connection from /127.0.0.1:58970
    [junit] 2013-12-20 00:47:51,128 [myid:] - INFO  [NIOServerCxn.Factory:0.0.0.0/0.0.0.0:11221:NIOServerCnxn@827] - Processing stat command from /127.0.0.1:58970
    [junit] 2013-12-20 00:47:51,128 [myid:] - INFO  [Thread-4:NIOServerCnxn$StatCommand@663] - Stat command output
    [junit] 2013-12-20 00:47:51,129 [myid:] - INFO  [Thread-4:NIOServerCnxn@1007] - Closed socket connection for client /127.0.0.1:58970 (no session established for client)
    [junit] 2013-12-20 00:47:51,129 [myid:] - INFO  [main:JMXEnv@135] - ensureOnly:[InMemoryDataTree, StandaloneServer_port]
    [junit] 2013-12-20 00:47:51,131 [myid:] - INFO  [main:JMXEnv@105] - expect:InMemoryDataTree
    [junit] 2013-12-20 00:47:51,131 [myid:] - INFO  [main:JMXEnv@108] - found:InMemoryDataTree org.apache.ZooKeeperService:name0=StandaloneServer_port-1,name1=InMemoryDataTree
    [junit] 2013-12-20 00:47:51,131 [myid:] - INFO  [main:JMXEnv@105] - expect:StandaloneServer_port
    [junit] 2013-12-20 00:47:51,131 [myid:] - INFO  [main:JMXEnv@108] - found:StandaloneServer_port org.apache.ZooKeeperService:name0=StandaloneServer_port-1
    [junit] 2013-12-20 00:47:51,134 [myid:] - INFO  [main:JUnit4ZKTestRunner$LoggedInvokeMethod@55] - Memory used 19610
    [junit] 2013-12-20 00:47:51,134 [myid:] - INFO  [main:JUnit4ZKTestRunner$LoggedInvokeMethod@60] - Number of threads 20
    [junit] 2013-12-20 00:47:51,134 [myid:] - INFO  [main:JUnit4ZKTestRunner$LoggedInvokeMethod@65] - FINISHED TEST METHOD testQuota
    [junit] 2013-12-20 00:47:51,135 [myid:] - INFO  [main:ClientBase@450] - tearDown starting
    [junit] 2013-12-20 00:47:51,204 [myid:] - INFO  [main:ZooKeeper@684] - Session: 0x1430d7901ee0000 closed
    [junit] 2013-12-20 00:47:51,205 [myid:] - INFO  [main-EventThread:ClientCnxn$EventThread@509] - EventThread shut down
    [junit] 2013-12-20 00:47:51,205 [myid:] - INFO  [main:ClientBase@420] - STOPPING server
    [junit] 2013-12-20 00:47:51,205 [myid:] - INFO  [NIOServerCxn.Factory:0.0.0.0/0.0.0.0:11221:NIOServerCnxnFactory@224] - NIOServerCnxn factory exited run method
    [junit] 2013-12-20 00:47:51,206 [myid:] - INFO  [main:ZooKeeperServer@441] - shutting down
    [junit] 2013-12-20 00:47:51,206 [myid:] - INFO  [main:SessionTrackerImpl@225] - Shutting down
    [junit] 2013-12-20 00:47:51,206 [myid:] - INFO  [main:PrepRequestProcessor@761] - Shutting down
    [junit] 2013-12-20 00:47:51,206 [myid:] - INFO  [main:SyncRequestProcessor@209] - Shutting down
    [junit] 2013-12-20 00:47:51,206 [myid:] - INFO  [ProcessThread(sid:0 cport:-1)::PrepRequestProcessor@143] - PrepRequestProcessor exited loop!
    [junit] 2013-12-20 00:47:51,207 [myid:] - INFO  [SyncThread:0:SyncRequestProcessor@187] - SyncRequestProcessor exited!
    [junit] 2013-12-20 00:47:51,207 [myid:] - INFO  [main:FinalRequestProcessor@415] - shutdown of request processor complete
    [junit] 2013-12-20 00:47:51,208 [myid:] - INFO  [main:FourLetterWordMain@43] - connecting to 127.0.0.1 11221
    [junit] 2013-12-20 00:47:51,208 [myid:] - INFO  [main:JMXEnv@135] - ensureOnly:[]
    [junit] 2013-12-20 00:47:51,212 [myid:] - INFO  [main:ClientBase@475] - fdcount after test is: 46 at start it was 34
    [junit] 2013-12-20 00:47:51,212 [myid:] - INFO  [main:ClientBase@477] - sleeping for 20 secs
    [junit] 2013-12-20 00:47:51,213 [myid:] - INFO  [main:ZKTestCase$1@60] - SUCCEEDED testQuota
    [junit] 2013-12-20 00:47:51,213 [myid:] - INFO  [main:ZKTestCase$1@55] - FINISHED testQuota
    [junit] Tests run: 1, Failures: 0, Errors: 0, Time elapsed: 0.789 sec

BUILD FAILED
/home/jenkins/jenkins-slave/workspace/ZooKeeper_branch34_openjdk7/branch-3.4/build.xml:1251: Tests failed!

Total time: 34 minutes 46 seconds
Build step 'Execute shell' marked build as failure
[locks-and-latches] Releasing all the locks
[locks-and-latches] All the locks released
Recording test results
Email was triggered for: Failure
Sending email for trigger: Failure



###################################################################################
############################## FAILED TESTS (if any) ##############################
1 tests failed.
REGRESSION:  org.apache.zookeeper.test.AsyncHammerTest.testObserversHammer

Error Message:
QP failed to shutdown in 30 seconds: QuorumPeer[myid=1]0.0.0.0/0.0.0.0:11233

Stack Trace:
junit.framework.AssertionFailedError: QP failed to shutdown in 30 seconds: QuorumPeer[myid=1]0.0.0.0/0.0.0.0:11233
	at org.apache.zookeeper.test.QuorumBase.shutdown(QuorumBase.java:328)
	at org.apache.zookeeper.test.QuorumBase.shutdownServers(QuorumBase.java:307)
	at org.apache.zookeeper.test.QuorumBase.tearDown(QuorumBase.java:295)
	at org.apache.zookeeper.test.AsyncHammerTest.tearDown(AsyncHammerTest.java:66)
	at org.apache.zookeeper.test.AsyncHammerTest.testObserversHammer(AsyncHammerTest.java:218)
	at org.apache.zookeeper.JUnit4ZKTestRunner$LoggedInvokeMethod.evaluate(JUnit4ZKTestRunner.java:52)