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 2016/08/19 11:58:53 UTC
ZooKeeper-trunk-jdk8 - Build # 713 - Still Failing
See https://builds.apache.org/job/ZooKeeper-trunk-jdk8/713/
###################################################################################
########################## LAST 60 LINES OF THE CONSOLE ###########################
[...truncated 454383 lines...]
[junit] at sun.nio.ch.SocketChannelImpl.finishConnect(SocketChannelImpl.java:717)
[junit] at org.jboss.netty.channel.socket.nio.NioClientBoss.connect(NioClientBoss.java:152)
[junit] at org.jboss.netty.channel.socket.nio.NioClientBoss.processSelectedKeys(NioClientBoss.java:105)
[junit] at org.jboss.netty.channel.socket.nio.NioClientBoss.process(NioClientBoss.java:79)
[junit] at org.jboss.netty.channel.socket.nio.AbstractNioSelector.run(AbstractNioSelector.java:337)
[junit] at org.jboss.netty.channel.socket.nio.NioClientBoss.run(NioClientBoss.java:42)
[junit] at org.jboss.netty.util.ThreadRenamingRunnable.run(ThreadRenamingRunnable.java:108)
[junit] at org.jboss.netty.util.internal.DeadLockProofWorker$1.run(DeadLockProofWorker.java:42)
[junit] at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142)
[junit] at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617)
[junit] at java.lang.Thread.run(Thread.java:745)
[junit] 2016-08-19 11:57:57,313 [myid:] - INFO [New I/O boss #9438:ClientCnxnSocketNetty@208] - channel is told closing
[junit] 2016-08-19 11:57:57,313 [myid:127.0.0.1:24811] - INFO [main-SendThread(127.0.0.1:24811):ClientCnxn$SendThread@1231] - channel for sessionid 0x201a7f3649b0000 is lost, closing socket connection and attempting reconnect
[junit] 2016-08-19 11:57:57,640 [myid:] - INFO [ProcessThread(sid:0 cport:24931)::PrepRequestProcessor@647] - Processed session termination for sessionid: 0x101a7f6c3b90000
[junit] 2016-08-19 11:57:57,652 [myid:] - INFO [main:ClientCnxnSocketNetty@208] - channel is told closing
[junit] 2016-08-19 11:57:57,652 [myid:] - INFO [SyncThread:0:MBeanRegistry@128] - Unregister MBean [org.apache.ZooKeeperService:name0=StandaloneServer_port24931,name1=Connections,name2=127.0.0.1,name3=0x101a7f6c3b90000]
[junit] 2016-08-19 11:57:57,652 [myid:] - INFO [New I/O worker #14359:ClientCnxnSocketNetty$ZKClientHandler@384] - channel is disconnected: [id: 0x44cc7320, /127.0.0.1:53614 :> 127.0.0.1/127.0.0.1:24931]
[junit] 2016-08-19 11:57:57,652 [myid:] - INFO [New I/O worker #14359:ClientCnxnSocketNetty@208] - channel is told closing
[junit] 2016-08-19 11:57:57,652 [myid:] - INFO [main:ZooKeeper@1313] - Session: 0x101a7f6c3b90000 closed
[junit] 2016-08-19 11:57:57,652 [myid:] - INFO [main-EventThread:ClientCnxn$EventThread@513] - EventThread shut down for session: 0x101a7f6c3b90000
[junit] 2016-08-19 11:57:57,652 [myid:] - INFO [main:JUnit4ZKTestRunner$LoggedInvokeMethod@82] - Memory used 156715
[junit] 2016-08-19 11:57:57,653 [myid:] - INFO [main:JUnit4ZKTestRunner$LoggedInvokeMethod@87] - Number of threads 1778
[junit] 2016-08-19 11:57:57,653 [myid:] - INFO [main:JUnit4ZKTestRunner$LoggedInvokeMethod@102] - FINISHED TEST METHOD testWatcherAutoResetWithLocal
[junit] 2016-08-19 11:57:57,653 [myid:] - INFO [main:ClientBase@543] - tearDown starting
[junit] 2016-08-19 11:57:57,653 [myid:] - INFO [main:ClientBase@513] - STOPPING server
[junit] 2016-08-19 11:57:57,653 [myid:] - INFO [main:NettyServerCnxnFactory@464] - shutdown called 0.0.0.0/0.0.0.0:24931
[junit] 2016-08-19 11:57:57,658 [myid:] - INFO [main:ZooKeeperServer@529] - shutting down
[junit] 2016-08-19 11:57:57,658 [myid:] - ERROR [main:ZooKeeperServer@501] - ZKShutdownHandler is not registered, so ZooKeeper server won't take any action on ERROR or SHUTDOWN server state changes
[junit] 2016-08-19 11:57:57,659 [myid:] - INFO [main:SessionTrackerImpl@232] - Shutting down
[junit] 2016-08-19 11:57:57,659 [myid:] - INFO [main:PrepRequestProcessor@965] - Shutting down
[junit] 2016-08-19 11:57:57,659 [myid:] - INFO [main:SyncRequestProcessor@191] - Shutting down
[junit] 2016-08-19 11:57:57,659 [myid:] - INFO [ProcessThread(sid:0 cport:24931)::PrepRequestProcessor@154] - PrepRequestProcessor exited loop!
[junit] 2016-08-19 11:57:57,659 [myid:] - INFO [SyncThread:0:SyncRequestProcessor@169] - SyncRequestProcessor exited!
[junit] 2016-08-19 11:57:57,659 [myid:] - INFO [main:FinalRequestProcessor@479] - shutdown of request processor complete
[junit] 2016-08-19 11:57:57,659 [myid:] - INFO [main:MBeanRegistry@128] - Unregister MBean [org.apache.ZooKeeperService:name0=StandaloneServer_port24931,name1=InMemoryDataTree]
[junit] 2016-08-19 11:57:57,660 [myid:] - INFO [main:MBeanRegistry@128] - Unregister MBean [org.apache.ZooKeeperService:name0=StandaloneServer_port24931]
[junit] 2016-08-19 11:57:57,660 [myid:] - INFO [main:FourLetterWordMain@85] - connecting to 127.0.0.1 24931
[junit] 2016-08-19 11:57:57,660 [myid:] - INFO [main:JMXEnv@146] - ensureOnly:[]
[junit] 2016-08-19 11:57:57,664 [myid:] - INFO [main:ClientBase@568] - fdcount after test is: 5114 at start it was 5114
[junit] 2016-08-19 11:57:57,665 [myid:] - INFO [main:ZKTestCase$1@65] - SUCCEEDED testWatcherAutoResetWithLocal
[junit] 2016-08-19 11:57:57,665 [myid:] - INFO [main:ZKTestCase$1@60] - FINISHED testWatcherAutoResetWithLocal
[junit] Tests run: 101, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: 563.996 sec, Thread: 6, Class: org.apache.zookeeper.test.NettyNettySuiteTest
[junit] 2016-08-19 11:57:57,986 [myid:] - INFO [SessionTracker:SessionTrackerImpl@158] - SessionTrackerImpl exited loop!
[junit] 2016-08-19 11:57:57,986 [myid:] - INFO [SessionTracker:SessionTrackerImpl@158] - SessionTrackerImpl exited loop!
[junit] Test org.apache.zookeeper.test.NettyNettySuiteTest FAILED
BUILD FAILED
/home/jenkins/jenkins-slave/workspace/ZooKeeper-trunk-jdk8/trunk/build.xml:1207: Tests failed!
Total time: 14 minutes 7 seconds
Build step 'Invoke Ant' marked build as failure
[WARNINGS] Skipping publisher since build result is FAILURE
Recording test results
Setting JDK_1_8_LATEST__HOME=/home/jenkins/tools/java/latest1.8
Setting JDK_1_8_LATEST__HOME=/home/jenkins/tools/java/latest1.8
Email was triggered for: Failure - Any
Sending email for trigger: Failure - Any
Setting JDK_1_8_LATEST__HOME=/home/jenkins/tools/java/latest1.8
Setting JDK_1_8_LATEST__HOME=/home/jenkins/tools/java/latest1.8
###################################################################################
############################## FAILED TESTS (if any) ##############################
1 tests failed.
FAILED: org.apache.zookeeper.test.WatcherTest.testWatchAutoResetWithPending
Error Message:
For 63 expected:<1> but was:<0>
Stack Trace:
junit.framework.AssertionFailedError: For 63 expected:<1> but was:<0>
at org.apache.zookeeper.test.WatcherTest.testWatchAutoResetWithPending(WatcherTest.java:215)
at org.apache.zookeeper.JUnit4ZKTestRunner$LoggedInvokeMethod.evaluate(JUnit4ZKTestRunner.java:79)
ZooKeeper-trunk-jdk8 - Build # 714 - Still Failing
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See https://builds.apache.org/job/ZooKeeper-trunk-jdk8/714/
###################################################################################
########################## LAST 60 LINES OF THE CONSOLE ###########################
[...truncated 448221 lines...]
[junit] 2016-08-20 11:58:47,271 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1113] - Opening socket connection to server 127.0.0.1/127.0.0.1:24702. Will not attempt to authenticate using SASL (unknown error)
[junit] 2016-08-20 11:58:47,272 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@948] - Socket connection established, initiating session, client: /127.0.0.1:48320, server: 127.0.0.1/127.0.0.1:24702
[junit] 2016-08-20 11:58:47,272 [myid:] - INFO [NIOServerCxnFactory.AcceptThread:/127.0.0.1:24702:NIOServerCnxnFactory$AcceptThread@296] - Accepted socket connection from /127.0.0.1:48320
[junit] 2016-08-20 11:58:47,272 [myid:] - WARN [NIOWorkerThread-18:NIOServerCnxn@369] - Exception causing close of session 0x0: ZooKeeperServer not running
[junit] 2016-08-20 11:58:47,273 [myid:] - INFO [NIOWorkerThread-18:NIOServerCnxn@607] - Closed socket connection for client /127.0.0.1:48320 (no session established for client)
[junit] 2016-08-20 11:58:47,273 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1231] - Unable to read additional data from server sessionid 0x301ad1079ca0000, likely server has closed socket, closing socket connection and attempting reconnect
[junit] 2016-08-20 11:58:49,162 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1113] - Opening socket connection to server 127.0.0.1/127.0.0.1:24702. Will not attempt to authenticate using SASL (unknown error)
[junit] 2016-08-20 11:58:49,163 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@948] - Socket connection established, initiating session, client: /127.0.0.1:48334, server: 127.0.0.1/127.0.0.1:24702
[junit] 2016-08-20 11:58:49,164 [myid:] - INFO [NIOServerCxnFactory.AcceptThread:/127.0.0.1:24702:NIOServerCnxnFactory$AcceptThread@296] - Accepted socket connection from /127.0.0.1:48334
[junit] 2016-08-20 11:58:49,164 [myid:] - WARN [NIOWorkerThread-19:NIOServerCnxn@369] - Exception causing close of session 0x0: ZooKeeperServer not running
[junit] 2016-08-20 11:58:49,164 [myid:] - INFO [NIOWorkerThread-19:NIOServerCnxn@607] - Closed socket connection for client /127.0.0.1:48334 (no session established for client)
[junit] 2016-08-20 11:58:49,164 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1231] - Unable to read additional data from server sessionid 0x301ad1079ca0000, likely server has closed socket, closing socket connection and attempting reconnect
[junit] 2016-08-20 11:58:50,387 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1113] - Opening socket connection to server 127.0.0.1/127.0.0.1:24702. Will not attempt to authenticate using SASL (unknown error)
[junit] 2016-08-20 11:58:50,387 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@948] - Socket connection established, initiating session, client: /127.0.0.1:48344, server: 127.0.0.1/127.0.0.1:24702
[junit] 2016-08-20 11:58:50,387 [myid:] - INFO [NIOServerCxnFactory.AcceptThread:/127.0.0.1:24702:NIOServerCnxnFactory$AcceptThread@296] - Accepted socket connection from /127.0.0.1:48344
[junit] 2016-08-20 11:58:50,388 [myid:] - WARN [NIOWorkerThread-20:NIOServerCnxn@369] - Exception causing close of session 0x0: ZooKeeperServer not running
[junit] 2016-08-20 11:58:50,388 [myid:] - INFO [NIOWorkerThread-20:NIOServerCnxn@607] - Closed socket connection for client /127.0.0.1:48344 (no session established for client)
[junit] 2016-08-20 11:58:50,388 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1231] - Unable to read additional data from server sessionid 0x301ad1079ca0000, likely server has closed socket, closing socket connection and attempting reconnect
[junit] 2016-08-20 11:58:52,361 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1113] - Opening socket connection to server 127.0.0.1/127.0.0.1:24702. Will not attempt to authenticate using SASL (unknown error)
[junit] 2016-08-20 11:58:52,362 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@948] - Socket connection established, initiating session, client: /127.0.0.1:48359, server: 127.0.0.1/127.0.0.1:24702
[junit] 2016-08-20 11:58:52,362 [myid:] - INFO [NIOServerCxnFactory.AcceptThread:/127.0.0.1:24702:NIOServerCnxnFactory$AcceptThread@296] - Accepted socket connection from /127.0.0.1:48359
[junit] 2016-08-20 11:58:52,362 [myid:] - WARN [NIOWorkerThread-21:NIOServerCnxn@369] - Exception causing close of session 0x0: ZooKeeperServer not running
[junit] 2016-08-20 11:58:52,363 [myid:] - INFO [NIOWorkerThread-21:NIOServerCnxn@607] - Closed socket connection for client /127.0.0.1:48359 (no session established for client)
[junit] 2016-08-20 11:58:52,363 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1231] - Unable to read additional data from server sessionid 0x301ad1079ca0000, likely server has closed socket, closing socket connection and attempting reconnect
[junit] 2016-08-20 11:58:54,044 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1113] - Opening socket connection to server 127.0.0.1/127.0.0.1:24702. Will not attempt to authenticate using SASL (unknown error)
[junit] 2016-08-20 11:58:54,045 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@948] - Socket connection established, initiating session, client: /127.0.0.1:48368, server: 127.0.0.1/127.0.0.1:24702
[junit] 2016-08-20 11:58:54,045 [myid:] - INFO [NIOServerCxnFactory.AcceptThread:/127.0.0.1:24702:NIOServerCnxnFactory$AcceptThread@296] - Accepted socket connection from /127.0.0.1:48368
[junit] 2016-08-20 11:58:54,045 [myid:] - WARN [NIOWorkerThread-23:NIOServerCnxn@369] - Exception causing close of session 0x0: ZooKeeperServer not running
[junit] 2016-08-20 11:58:54,045 [myid:] - INFO [NIOWorkerThread-23:NIOServerCnxn@607] - Closed socket connection for client /127.0.0.1:48368 (no session established for client)
[junit] 2016-08-20 11:58:54,046 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1231] - Unable to read additional data from server sessionid 0x301ad1079ca0000, likely server has closed socket, closing socket connection and attempting reconnect
[junit] 2016-08-20 11:58:55,172 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1113] - Opening socket connection to server 127.0.0.1/127.0.0.1:24702. Will not attempt to authenticate using SASL (unknown error)
[junit] 2016-08-20 11:58:55,173 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@948] - Socket connection established, initiating session, client: /127.0.0.1:48375, server: 127.0.0.1/127.0.0.1:24702
[junit] 2016-08-20 11:58:55,173 [myid:] - INFO [NIOServerCxnFactory.AcceptThread:/127.0.0.1:24702:NIOServerCnxnFactory$AcceptThread@296] - Accepted socket connection from /127.0.0.1:48375
[junit] 2016-08-20 11:58:55,173 [myid:] - WARN [NIOWorkerThread-24:NIOServerCnxn@369] - Exception causing close of session 0x0: ZooKeeperServer not running
[junit] 2016-08-20 11:58:55,173 [myid:] - INFO [NIOWorkerThread-24:NIOServerCnxn@607] - Closed socket connection for client /127.0.0.1:48375 (no session established for client)
[junit] 2016-08-20 11:58:55,174 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1231] - Unable to read additional data from server sessionid 0x301ad1079ca0000, likely server has closed socket, closing socket connection and attempting reconnect
[junit] 2016-08-20 11:58:56,338 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1113] - Opening socket connection to server 127.0.0.1/127.0.0.1:24702. Will not attempt to authenticate using SASL (unknown error)
[junit] 2016-08-20 11:58:56,339 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@948] - Socket connection established, initiating session, client: /127.0.0.1:48383, server: 127.0.0.1/127.0.0.1:24702
[junit] 2016-08-20 11:58:56,339 [myid:] - INFO [NIOServerCxnFactory.AcceptThread:/127.0.0.1:24702:NIOServerCnxnFactory$AcceptThread@296] - Accepted socket connection from /127.0.0.1:48383
[junit] 2016-08-20 11:58:56,339 [myid:] - WARN [NIOWorkerThread-25:NIOServerCnxn@369] - Exception causing close of session 0x0: ZooKeeperServer not running
[junit] 2016-08-20 11:58:56,339 [myid:] - INFO [NIOWorkerThread-25:NIOServerCnxn@607] - Closed socket connection for client /127.0.0.1:48383 (no session established for client)
[junit] 2016-08-20 11:58:56,339 [myid:127.0.0.1:24702] - INFO [main-SendThread(127.0.0.1:24702):ClientCnxn$SendThread@1231] - Unable to read additional data from server sessionid 0x301ad1079ca0000, likely server has closed socket, closing socket connection and attempting reconnect
[junit] Running org.apache.zookeeper.server.ZxidRolloverTest in thread 6
[junit] Tests run: 1, Failures: 0, Errors: 1, Skipped: 0, Time elapsed: 0 sec, Thread: 6, Class: org.apache.zookeeper.server.ZxidRolloverTest
[junit] Test org.apache.zookeeper.server.ZxidRolloverTest FAILED (timeout)
BUILD FAILED
/home/jenkins/jenkins-slave/workspace/ZooKeeper-trunk-jdk8/trunk/build.xml:1207: Tests failed!
Total time: 15 minutes 33 seconds
Build step 'Invoke Ant' marked build as failure
[WARNINGS] Skipping publisher since build result is FAILURE
Recording test results
Setting JDK_1_8_LATEST__HOME=/home/jenkins/tools/java/latest1.8
Setting JDK_1_8_LATEST__HOME=/home/jenkins/tools/java/latest1.8
Email was triggered for: Failure - Any
Sending email for trigger: Failure - Any
Setting JDK_1_8_LATEST__HOME=/home/jenkins/tools/java/latest1.8
Setting JDK_1_8_LATEST__HOME=/home/jenkins/tools/java/latest1.8
###################################################################################
############################## FAILED TESTS (if any) ##############################
2 tests failed.
FAILED: org.apache.zookeeper.server.ZxidRolloverTest.testRolloverThenLeaderRestart
Error Message:
Timeout occurred. Please note the time in the report does not reflect the time until the timeout.
Stack Trace:
junit.framework.AssertionFailedError: Timeout occurred. Please note the time in the report does not reflect the time until the timeout.
at java.lang.Thread.run(Thread.java:745)
FAILED: org.apache.zookeeper.server.quorum.RaceConditionTest.testRaceConditionBetweenLeaderAndAckRequestProcessor
Error Message:
Leader failed to transition to LOOKING or FOLLOWING state
Stack Trace:
junit.framework.AssertionFailedError: Leader failed to transition to LOOKING or FOLLOWING state
at org.apache.zookeeper.server.quorum.RaceConditionTest.testRaceConditionBetweenLeaderAndAckRequestProcessor(RaceConditionTest.java:74)
at org.apache.zookeeper.JUnit4ZKTestRunner$LoggedInvokeMethod.evaluate(JUnit4ZKTestRunner.java:79)
at java.util.concurrent.FutureTask.run(FutureTask.java:266)
at java.lang.Thread.run(Thread.java:745)