You are viewing a plain text version of this content. The canonical link for it is here.
Posted to dev@hama.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2015/04/09 15:22:36 UTC
Build failed in Jenkins: Hama-trunk #368
See <https://builds.apache.org/job/Hama-trunk/368/changes>
Changes:
[edwardyoon] HAMA-947: duplicate hama-*.jars in lib directory
------------------------------------------
[...truncated 133578 lines...]
15/04/09 13:22:03 INFO bsp.LocalBSPRunner: Setting up a new barrier for 1 tasks!
15/04/09 13:22:03 INFO Configuration.deprecation: io.sort.mb is deprecated. Instead, use mapreduce.task.io.sort.mb
15/04/09 13:22:03 INFO Configuration.deprecation: io.sort.factor is deprecated. Instead, use mapreduce.task.io.sort.factor
15/04/09 13:22:03 INFO Configuration.deprecation: mapred.cache.localFiles is deprecated. Instead, use mapreduce.job.cache.local.files
15/04/09 13:22:06 INFO bsp.BSPJobClient: Current supersteps number: 1
15/04/09 13:22:06 INFO bsp.BSPJobClient: The total number of supersteps: 1
15/04/09 13:22:06 INFO bsp.BSPJobClient: Counters: 6
15/04/09 13:22:06 INFO bsp.BSPJobClient: org.apache.hama.bsp.JobInProgress$JobCounter
15/04/09 13:22:06 INFO bsp.BSPJobClient: SUPERSTEPS=1
15/04/09 13:22:06 INFO bsp.BSPJobClient: LAUNCHED_TASKS=1
15/04/09 13:22:06 INFO bsp.BSPJobClient: org.apache.hama.bsp.BSPPeerImpl$PeerCounter
15/04/09 13:22:06 INFO bsp.BSPJobClient: SUPERSTEP_SUM=2
15/04/09 13:22:06 INFO bsp.BSPJobClient: IO_BYTES_READ=26
15/04/09 13:22:06 INFO bsp.BSPJobClient: TIME_IN_SYNC_MS=0
15/04/09 13:22:06 INFO bsp.BSPJobClient: TASK_INPUT_RECORDS=4
15/04/09 13:22:06 INFO bsp.FileInputFormat: Total input paths to process : 2
15/04/09 13:22:06 WARN bsp.BSPJobClient: No job jar file set. User classes may not be found. See BSPJob#setJar(String) or check Your jar file.
15/04/09 13:22:06 WARN conf.Configuration: org.apache.hadoop.fs.ChecksumFileSystem$FSDataBoundedInputStream@8135a0:an attempt to override final parameter: mapreduce.job.end-notification.max.retry.interval; Ignoring.
15/04/09 13:22:06 WARN conf.Configuration: org.apache.hadoop.fs.ChecksumFileSystem$FSDataBoundedInputStream@8135a0:an attempt to override final parameter: mapreduce.job.end-notification.max.attempts; Ignoring.
15/04/09 13:22:06 INFO Configuration.deprecation: user.name is deprecated. Instead, use mapreduce.job.user.name
15/04/09 13:22:06 INFO bsp.LocalBSPRunner: Setting up a new barrier for 2 tasks!
15/04/09 13:22:06 INFO bsp.BSPJobClient: Running job: job_localrunner_0001
15/04/09 13:22:06 INFO graph.GraphJobRunner: 2 vertices are loaded into local:1
15/04/09 13:22:06 INFO graph.GraphJobRunner: 2 vertices are loaded into local:0
15/04/09 13:22:09 INFO bsp.BSPJobClient: Current supersteps number: 7
15/04/09 13:22:09 INFO bsp.BSPJobClient: The total number of supersteps: 7
15/04/09 13:22:09 INFO bsp.BSPJobClient: Counters: 12
15/04/09 13:22:09 INFO bsp.BSPJobClient: org.apache.hama.graph.GraphJobRunner$GraphJobCounter
15/04/09 13:22:09 INFO bsp.BSPJobClient: ITERATIONS=6
15/04/09 13:22:09 INFO bsp.BSPJobClient: INPUT_VERTICES=4
15/04/09 13:22:09 INFO bsp.BSPJobClient: org.apache.hama.bsp.JobInProgress$JobCounter
15/04/09 13:22:09 INFO bsp.BSPJobClient: SUPERSTEPS=7
15/04/09 13:22:09 INFO bsp.BSPJobClient: LAUNCHED_TASKS=2
15/04/09 13:22:09 INFO bsp.BSPJobClient: org.apache.hama.bsp.BSPPeerImpl$PeerCounter
15/04/09 13:22:09 INFO bsp.BSPJobClient: SUPERSTEP_SUM=16
15/04/09 13:22:09 INFO bsp.BSPJobClient: IO_BYTES_READ=90
15/04/09 13:22:09 INFO bsp.BSPJobClient: TIME_IN_SYNC_MS=16
15/04/09 13:22:09 INFO bsp.BSPJobClient: TOTAL_MESSAGES_SENT=38
15/04/09 13:22:09 INFO bsp.BSPJobClient: TASK_INPUT_RECORDS=4
15/04/09 13:22:09 INFO bsp.BSPJobClient: TOTAL_MESSAGE_BYTES_TRANSFERED=6564
15/04/09 13:22:09 INFO bsp.BSPJobClient: TOTAL_MESSAGES_RECEIVED=36
15/04/09 13:22:09 INFO bsp.BSPJobClient: TASK_OUTPUT_RECORDS=4
Job Finished in 6.749 seconds
D -> C R expvalue = C R
B -> A R expvalue = A R
C -> D L expvalue = D L
A -> B L expvalue = B L
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.009 sec
Running org.apache.hama.examples.SemiClusterMatchingTest
15/04/09 13:22:10 WARN util.NativeCodeLoader: Unable to load native-hadoop library for your platform... using builtin-java classes where applicable
15/04/09 13:22:10 INFO bsp.FileInputFormat: Total input paths to process : 1
15/04/09 13:22:11 INFO bsp.FileInputFormat: Total input paths to process : 1
15/04/09 13:22:11 WARN bsp.BSPJobClient: No job jar file set. User classes may not be found. See BSPJob#setJar(String) or check Your jar file.
15/04/09 13:22:11 INFO Configuration.deprecation: user.name is deprecated. Instead, use mapreduce.job.user.name
15/04/09 13:22:11 WARN conf.Configuration: org.apache.hadoop.fs.ChecksumFileSystem$FSDataBoundedInputStream@16b67f3:an attempt to override final parameter: mapreduce.job.end-notification.max.retry.interval; Ignoring.
15/04/09 13:22:11 WARN conf.Configuration: org.apache.hadoop.fs.ChecksumFileSystem$FSDataBoundedInputStream@16b67f3:an attempt to override final parameter: mapreduce.job.end-notification.max.attempts; Ignoring.
15/04/09 13:22:11 INFO Configuration.deprecation: user.name is deprecated. Instead, use mapreduce.job.user.name
15/04/09 13:22:11 INFO bsp.BSPJobClient: Running job: job_localrunner_0001
15/04/09 13:22:11 INFO bsp.LocalBSPRunner: Setting up a new barrier for 1 tasks!
15/04/09 13:22:11 INFO Configuration.deprecation: io.sort.mb is deprecated. Instead, use mapreduce.task.io.sort.mb
15/04/09 13:22:11 INFO Configuration.deprecation: io.sort.factor is deprecated. Instead, use mapreduce.task.io.sort.factor
15/04/09 13:22:11 INFO Configuration.deprecation: mapred.cache.localFiles is deprecated. Instead, use mapreduce.job.cache.local.files
15/04/09 13:22:14 INFO bsp.BSPJobClient: Current supersteps number: 1
15/04/09 13:22:14 INFO bsp.BSPJobClient: The total number of supersteps: 1
15/04/09 13:22:14 INFO bsp.BSPJobClient: Counters: 6
15/04/09 13:22:14 INFO bsp.BSPJobClient: org.apache.hama.bsp.JobInProgress$JobCounter
15/04/09 13:22:14 INFO bsp.BSPJobClient: SUPERSTEPS=1
15/04/09 13:22:14 INFO bsp.BSPJobClient: LAUNCHED_TASKS=1
15/04/09 13:22:14 INFO bsp.BSPJobClient: org.apache.hama.bsp.BSPPeerImpl$PeerCounter
15/04/09 13:22:14 INFO bsp.BSPJobClient: SUPERSTEP_SUM=2
15/04/09 13:22:14 INFO bsp.BSPJobClient: IO_BYTES_READ=7189
15/04/09 13:22:14 INFO bsp.BSPJobClient: TIME_IN_SYNC_MS=0
15/04/09 13:22:14 INFO bsp.BSPJobClient: TASK_INPUT_RECORDS=100
15/04/09 13:22:14 INFO bsp.FileInputFormat: Total input paths to process : 3
15/04/09 13:22:14 WARN bsp.BSPJobClient: No job jar file set. User classes may not be found. See BSPJob#setJar(String) or check Your jar file.
15/04/09 13:22:14 WARN conf.Configuration: org.apache.hadoop.fs.ChecksumFileSystem$FSDataBoundedInputStream@11ba877:an attempt to override final parameter: mapreduce.job.end-notification.max.retry.interval; Ignoring.
15/04/09 13:22:14 WARN conf.Configuration: org.apache.hadoop.fs.ChecksumFileSystem$FSDataBoundedInputStream@11ba877:an attempt to override final parameter: mapreduce.job.end-notification.max.attempts; Ignoring.
15/04/09 13:22:14 INFO Configuration.deprecation: user.name is deprecated. Instead, use mapreduce.job.user.name
15/04/09 13:22:14 INFO bsp.LocalBSPRunner: Setting up a new barrier for 3 tasks!
15/04/09 13:22:14 INFO bsp.BSPJobClient: Running job: job_localrunner_0001
15/04/09 13:22:14 INFO graph.GraphJobRunner: 33 vertices are loaded into local:2
15/04/09 13:22:14 INFO graph.GraphJobRunner: 34 vertices are loaded into local:1
15/04/09 13:22:14 INFO graph.GraphJobRunner: 33 vertices are loaded into local:0
15/04/09 13:22:17 INFO bsp.BSPJobClient: Current supersteps number: 15
15/04/09 13:22:17 INFO bsp.BSPJobClient: The total number of supersteps: 15
15/04/09 13:22:17 INFO bsp.BSPJobClient: Counters: 12
15/04/09 13:22:17 INFO bsp.BSPJobClient: org.apache.hama.graph.GraphJobRunner$GraphJobCounter
15/04/09 13:22:17 INFO bsp.BSPJobClient: ITERATIONS=15
15/04/09 13:22:17 INFO bsp.BSPJobClient: INPUT_VERTICES=100
15/04/09 13:22:17 INFO bsp.BSPJobClient: org.apache.hama.bsp.JobInProgress$JobCounter
15/04/09 13:22:17 INFO bsp.BSPJobClient: SUPERSTEPS=15
15/04/09 13:22:17 INFO bsp.BSPJobClient: LAUNCHED_TASKS=3
15/04/09 13:22:17 INFO bsp.BSPJobClient: org.apache.hama.bsp.BSPPeerImpl$PeerCounter
15/04/09 13:22:17 INFO bsp.BSPJobClient: SUPERSTEP_SUM=48
15/04/09 13:22:17 INFO bsp.BSPJobClient: IO_BYTES_READ=8850
15/04/09 13:22:17 INFO bsp.BSPJobClient: TIME_IN_SYNC_MS=439
15/04/09 13:22:17 INFO bsp.BSPJobClient: TOTAL_MESSAGES_SENT=166114
15/04/09 13:22:17 INFO bsp.BSPJobClient: TASK_INPUT_RECORDS=100
15/04/09 13:22:17 INFO bsp.BSPJobClient: TOTAL_MESSAGE_BYTES_TRANSFERED=33240682
15/04/09 13:22:17 INFO bsp.BSPJobClient: TOTAL_MESSAGES_RECEIVED=4596
15/04/09 13:22:17 INFO bsp.BSPJobClient: TASK_OUTPUT_RECORDS=100
Job Finished in 6.734 seconds
C1599 = [14, 17]
Tests run: 1, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: 0.015 sec <<< FAILURE!
Results :
Failed tests:
testSemiClustering(org.apache.hama.examples.SemiClusterMatchingTest)
Tests run: 22, Failures: 1, Errors: 0, Skipped: 0
[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO]
[INFO] Apache Hama parent POM ............................ SUCCESS [14.520s]
[INFO] pipes ............................................. SUCCESS [22.888s]
[INFO] commons ........................................... SUCCESS [10.747s]
[INFO] core .............................................. SUCCESS [3:31.387s]
[INFO] graph ............................................. SUCCESS [22.091s]
[INFO] machine learning .................................. SUCCESS [2:10.263s]
[INFO] examples .......................................... FAILURE [2:03.284s]
[INFO] mesos ............................................. SKIPPED
[INFO] hama-dist ......................................... SKIPPED
[INFO] ------------------------------------------------------------------------
[INFO] BUILD FAILURE
[INFO] ------------------------------------------------------------------------
[INFO] Total time: 8:57.192s
[INFO] Finished at: Thu Apr 09 13:22:17 UTC 2015
[INFO] Final Memory: 128M/509M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.6:test (default-test) on project hama-examples: There are test failures.
[ERROR]
[ERROR] Please refer to <https://builds.apache.org/job/Hama-trunk/ws/trunk/examples/target/surefire-reports> for the individual test results.
[ERROR] -> [Help 1]
[ERROR]
[ERROR] To see the full stack trace of the errors, re-run Maven with the -e switch.
[ERROR] Re-run Maven using the -X switch to enable full debug logging.
[ERROR]
[ERROR] For more information about the errors and possible solutions, please read the following articles:
[ERROR] [Help 1] http://cwiki.apache.org/confluence/display/MAVEN/MojoFailureException
[ERROR]
[ERROR] After correcting the problems, you can resume the build with the command
[ERROR] mvn <goals> -rf :hama-examples
Build step 'Invoke top-level Maven targets' marked build as failure
Archiving artifacts
Sending artifact delta relative to Hama-trunk #367
Archived 143 artifacts
Archive block size is 32768
Received 0 blocks and 388886 bytes
Compression is 0.0%
Took 6 sec
Recording test results
Updating HAMA-947
Jenkins build is back to normal : Hama-trunk #372
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Hama-trunk/372/changes>
Build failed in Jenkins: Hama-trunk #371
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Hama-trunk/371/changes>
Changes:
[edwardyoon] load vertices concurrently
------------------------------------------
[...truncated 4267 lines...]
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.01 sec
Running org.apache.hama.bsp.TestZooKeeper
15/04/13 10:16:20 ERROR quorum.QuorumPeerConfig: Invalid configuration, only one server specified (ignoring)
15/04/13 10:16:20 INFO server.ZooKeeperServerMain: Starting server
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:zookeeper.version=3.4.5-1392090, built on 09/30/2012 17:52 GMT
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:host.name=pomona.apache.org
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:java.version=1.7.0_25
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:java.vendor=Oracle Corporation
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:java.home=/home/jenkins/tools/java/jdk1.7.0_25-32/jre
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:java.class.path=/tmp/surefirebooter1642000686643541000.jar
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:java.library.path=/usr/java/packages/lib/i386:/lib:/usr/lib
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:java.io.tmpdir=/tmp
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:java.compiler=<NA>
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:os.name=Linux
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:os.arch=i386
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:os.version=3.13.0-36-lowlatency
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:user.name=jenkins
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:user.home=/home/jenkins
15/04/13 10:16:20 INFO server.ZooKeeperServer: Server environment:user.dir=/tmp
15/04/13 10:16:20 INFO server.ZooKeeperServer: tickTime set to 3000
15/04/13 10:16:20 INFO server.ZooKeeperServer: minSessionTimeout set to -1
15/04/13 10:16:20 INFO server.ZooKeeperServer: maxSessionTimeout set to 1200000
15/04/13 10:16:20 INFO server.NIOServerCnxnFactory: binding to port 0.0.0.0/0.0.0.0:20000
15/04/13 10:16:20 INFO persistence.FileSnap: Reading snapshot /tmp/hama-testzookeeper/version-2/snapshot.86
15/04/13 10:16:20 INFO persistence.FileTxnSnapLog: Snapshotting: 0x8b to /tmp/hama-testzookeeper/version-2/snapshot.8b
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:zookeeper.version=3.4.5-1392090, built on 09/30/2012 17:52 GMT
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:host.name=pomona.apache.org
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:java.version=1.7.0_25
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:java.vendor=Oracle Corporation
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:java.home=/home/jenkins/tools/java/jdk1.7.0_25-32/jre
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:java.class.path=/tmp/surefirebooter1642000686643541000.jar
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:java.library.path=/usr/java/packages/lib/i386:/lib:/usr/lib
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:java.io.tmpdir=/tmp
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:java.compiler=<NA>
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:os.name=Linux
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:os.arch=i386
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:os.version=3.13.0-36-lowlatency
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:user.name=jenkins
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:user.home=/home/jenkins
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Client environment:user.dir=/tmp
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Initiating client connection, connectString=localhost:20000 sessionTimeout=1200000 watcher=org.apache.hama.bsp.sync.ZKSyncBSPMasterClient@1c0bc26
15/04/13 10:16:30 INFO sync.ZKSyncBSPMasterClient: Initialized ZK false
15/04/13 10:16:30 INFO sync.ZKSyncClient: Initializing ZK Sync Client
15/04/13 10:16:30 INFO zookeeper.ClientCnxn: Opening socket connection to server localhost/0:0:0:0:0:0:0:1:20000. Will not attempt to authenticate using SASL (unknown error)
15/04/13 10:16:30 INFO server.NIOServerCnxnFactory: Accepted socket connection from /0:0:0:0:0:0:0:1:33662
15/04/13 10:16:30 INFO zookeeper.ClientCnxn: Socket connection established to localhost/0:0:0:0:0:0:0:1:20000, initiating session
15/04/13 10:16:30 INFO server.ZooKeeperServer: Client attempting to establish new session at /0:0:0:0:0:0:0:1:33662
15/04/13 10:16:30 INFO persistence.FileTxnLog: Creating new log file: log.8c
15/04/13 10:16:30 INFO server.ZooKeeperServer: Established session 0x14cb2479ffd0000 with negotiated timeout 1200000 for client /0:0:0:0:0:0:0:1:33662
15/04/13 10:16:30 INFO zookeeper.ClientCnxn: Session establishment complete on server localhost/0:0:0:0:0:0:0:1:20000, sessionid = 0x14cb2479ffd0000, negotiated timeout = 1200000
15/04/13 10:16:30 INFO mortbay.log: Logging to org.slf4j.impl.Log4jLoggerAdapter(org.mortbay.log) via org.mortbay.log.Slf4jLog
15/04/13 10:16:30 INFO mortbay.log: Created master and client sync clients
15/04/13 10:16:30 INFO mortbay.log: BSP root exists
15/04/13 10:16:30 INFO zookeeper.ZooKeeper: Initiating client connection, connectString=localhost:20000 sessionTimeout=1200000 watcher=org.apache.hama.bsp.sync.ZooKeeperSyncClientImpl@109ddab
15/04/13 10:16:30 INFO sync.ZKSyncClient: Initializing ZK Sync Client
15/04/13 10:16:30 INFO zookeeper.ClientCnxn: Opening socket connection to server localhost/0:0:0:0:0:0:0:1:20000. Will not attempt to authenticate using SASL (unknown error)
15/04/13 10:16:30 INFO sync.ZooKeeperSyncClientImpl: Start connecting to Zookeeper! At /0.0.0.0:21815
15/04/13 10:16:30 INFO zookeeper.ClientCnxn: Socket connection established to localhost/0:0:0:0:0:0:0:1:20000, initiating session
15/04/13 10:16:30 INFO server.NIOServerCnxnFactory: Accepted socket connection from /0:0:0:0:0:0:0:1:33663
15/04/13 10:16:30 INFO server.ZooKeeperServer: Client attempting to establish new session at /0:0:0:0:0:0:0:1:33663
15/04/13 10:16:30 INFO server.ZooKeeperServer: Established session 0x14cb2479ffd0001 with negotiated timeout 1200000 for client /0:0:0:0:0:0:0:1:33663
15/04/13 10:16:30 INFO zookeeper.ClientCnxn: Session establishment complete on server localhost/0:0:0:0:0:0:0:1:20000, sessionid = 0x14cb2479ffd0001, negotiated timeout = 1200000
15/04/13 10:16:30 INFO sync.ZKSyncClient: Writing data /bsp/job_test1_0001/info/level2
15/04/13 10:16:30 INFO mortbay.log: Found child count = 2
15/04/13 10:16:30 INFO mortbay.log: Passed the child count test
15/04/13 10:16:30 INFO mortbay.log: Found child count = 2
15/04/13 10:16:30 INFO mortbay.log: Peer name 2
15/04/13 10:16:30 INFO mortbay.log: Peer name 1
15/04/13 10:16:30 INFO mortbay.log: Passed the child key set test
15/04/13 10:16:30 INFO mortbay.log: /bsp/job_test1_0001
15/04/13 10:16:31 INFO mortbay.log: Passed the key presence test
15/04/13 10:16:31 INFO sync.ZKSyncClient: Writing data /bsp/job_test1_0001/info/level3
15/04/13 10:16:31 INFO mortbay.log: Passed array writable test
15/04/13 10:16:31 INFO server.NIOServerCnxn: Closed socket connection for client /0:0:0:0:0:0:0:1:33663 which had sessionid 0x14cb2479ffd0001
15/04/13 10:16:31 INFO zookeeper.ClientCnxn: Unable to read additional data from server sessionid 0x14cb2479ffd0001, likely server has closed socket, closing socket connection and attempting reconnect
15/04/13 10:16:31 INFO server.NIOServerCnxn: Closed socket connection for client /0:0:0:0:0:0:0:1:33662 which had sessionid 0x14cb2479ffd0000
15/04/13 10:16:31 INFO zookeeper.ClientCnxn: Unable to read additional data from server sessionid 0x14cb2479ffd0000, likely server has closed socket, closing socket connection and attempting reconnect
15/04/13 10:16:31 INFO server.NIOServerCnxnFactory: NIOServerCnxn factory exited run method
15/04/13 10:16:31 INFO server.ZooKeeperServer: shutting down
15/04/13 10:16:31 INFO server.ZooKeeperServer: shutting down
15/04/13 10:16:31 INFO server.SessionTrackerImpl: Shutting down
15/04/13 10:16:31 INFO server.SessionTrackerImpl: Shutting down
15/04/13 10:16:31 INFO server.PrepRequestProcessor: Shutting down
15/04/13 10:16:31 INFO server.PrepRequestProcessor: Shutting down
15/04/13 10:16:31 INFO server.SyncRequestProcessor: Shutting down
15/04/13 10:16:31 INFO server.PrepRequestProcessor: PrepRequestProcessor exited loop!
15/04/13 10:16:31 INFO server.SyncRequestProcessor: SyncRequestProcessor exited!
15/04/13 10:16:31 INFO server.SyncRequestProcessor: Shutting down
15/04/13 10:16:31 INFO server.FinalRequestProcessor: shutdown of request processor complete
15/04/13 10:16:31 INFO server.FinalRequestProcessor: shutdown of request processor complete
15/04/13 10:16:31 WARN jmx.MBeanRegistry: Failed to unregister MBean InMemoryDataTree
15/04/13 10:16:31 WARN jmx.MBeanRegistry: Error during unregister
javax.management.InstanceNotFoundException: org.apache.ZooKeeperService:name0=StandaloneServer_port-1,name1=InMemoryDataTree
at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.getMBean(DefaultMBeanServerInterceptor.java:1095)
at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.exclusiveUnregisterMBean(DefaultMBeanServerInterceptor.java:427)
at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.unregisterMBean(DefaultMBeanServerInterceptor.java:415)
at com.sun.jmx.mbeanserver.JmxMBeanServer.unregisterMBean(JmxMBeanServer.java:546)
at org.apache.zookeeper.jmx.MBeanRegistry.unregister(MBeanRegistry.java:115)
at org.apache.zookeeper.jmx.MBeanRegistry.unregister(MBeanRegistry.java:132)
at org.apache.zookeeper.server.ZooKeeperServer.unregisterJMX(ZooKeeperServer.java:443)
at org.apache.zookeeper.server.ZooKeeperServer.shutdown(ZooKeeperServer.java:436)
at org.apache.zookeeper.server.ZooKeeperServerMain.runFromConfig(ZooKeeperServerMain.java:115)
at org.apache.hama.bsp.sync.ZooKeeperSyncServerImpl.start(ZooKeeperSyncServerImpl.java:79)
at org.apache.hama.bsp.TestZooKeeper$1.run(TestZooKeeper.java:76)
at java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:471)
at java.util.concurrent.FutureTask$Sync.innerRun(FutureTask.java:334)
at java.util.concurrent.FutureTask.run(FutureTask.java:166)
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:724)
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.011 sec
Results :
Failed tests:
Tests run: 56, Failures: 1, Errors: 0, Skipped: 0
[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO]
[INFO] Apache Hama parent POM ............................ SUCCESS [3.586s]
[INFO] pipes ............................................. SUCCESS [15.391s]
[INFO] commons ........................................... SUCCESS [6.186s]
[INFO] core .............................................. FAILURE [2:53.721s]
[INFO] graph ............................................. SKIPPED
[INFO] machine learning .................................. SKIPPED
[INFO] examples .......................................... SKIPPED
[INFO] mesos ............................................. SKIPPED
[INFO] hama-dist ......................................... SKIPPED
[INFO] ------------------------------------------------------------------------
[INFO] BUILD FAILURE
[INFO] ------------------------------------------------------------------------
[INFO] Total time: 3:19.456s
[INFO] Finished at: Mon Apr 13 10:16:31 UTC 2015
[INFO] Final Memory: 66M/627M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.6:test (default-test) on project hama-core: There are test failures.
[ERROR]
[ERROR] Please refer to <https://builds.apache.org/job/Hama-trunk/ws/trunk/core/target/surefire-reports> for the individual test results.
[ERROR] -> [Help 1]
[ERROR]
[ERROR] To see the full stack trace of the errors, re-run Maven with the -e switch.
[ERROR] Re-run Maven using the -X switch to enable full debug logging.
[ERROR]
[ERROR] For more information about the errors and possible solutions, please read the following articles:
[ERROR] [Help 1] http://cwiki.apache.org/confluence/display/MAVEN/MojoFailureException
[ERROR]
[ERROR] After correcting the problems, you can resume the build with the command
[ERROR] mvn <goals> -rf :hama-core
Build step 'Invoke top-level Maven targets' marked build as failure
Archiving artifacts
Sending artifact delta relative to Hama-trunk #367
Archived 149 artifacts
Archive block size is 32768
Received 3873 blocks and 342091 bytes
Compression is 99.7%
Took 17 sec
Recording test results
Build failed in Jenkins: Hama-trunk #370
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Hama-trunk/370/changes>
Changes:
[edwardyoon] HAMA-526: Multi-threaded vertex processing
------------------------------------------
[...truncated 4318 lines...]
15/04/13 08:16:23 INFO server.ZooKeeperServer: Server environment:user.dir=/tmp
15/04/13 08:16:23 INFO server.ZooKeeperServer: tickTime set to 3000
15/04/13 08:16:23 INFO server.ZooKeeperServer: minSessionTimeout set to -1
15/04/13 08:16:23 INFO server.ZooKeeperServer: maxSessionTimeout set to 1200000
15/04/13 08:16:23 INFO server.NIOServerCnxnFactory: binding to port 0.0.0.0/0.0.0.0:20000
15/04/13 08:16:23 INFO persistence.FileSnap: Reading snapshot /tmp/hama-testzookeeper/version-2/snapshot.64
15/04/13 08:16:23 INFO persistence.FileTxnSnapLog: Snapshotting: 0x69 to /tmp/hama-testzookeeper/version-2/snapshot.69
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:zookeeper.version=3.4.5-1392090, built on 09/30/2012 17:52 GMT
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:host.name=pomona.apache.org
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:java.version=1.7.0_25
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:java.vendor=Oracle Corporation
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:java.home=/home/jenkins/tools/java/jdk1.7.0_25-32/jre
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:java.class.path=/tmp/surefirebooter1661539759480669496.jar
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:java.library.path=/usr/java/packages/lib/i386:/lib:/usr/lib
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:java.io.tmpdir=/tmp
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:java.compiler=<NA>
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:os.name=Linux
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:os.arch=i386
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:os.version=3.13.0-36-lowlatency
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:user.name=jenkins
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:user.home=/home/jenkins
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Client environment:user.dir=/tmp
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Initiating client connection, connectString=localhost:20000 sessionTimeout=1200000 watcher=org.apache.hama.bsp.sync.ZKSyncBSPMasterClient@10a0696
15/04/13 08:16:33 INFO sync.ZKSyncBSPMasterClient: Initialized ZK false
15/04/13 08:16:33 INFO sync.ZKSyncClient: Initializing ZK Sync Client
15/04/13 08:16:33 INFO zookeeper.ClientCnxn: Opening socket connection to server localhost/127.0.0.1:20000. Will not attempt to authenticate using SASL (unknown error)
15/04/13 08:16:33 INFO zookeeper.ClientCnxn: Socket connection established to localhost/127.0.0.1:20000, initiating session
15/04/13 08:16:33 INFO server.NIOServerCnxnFactory: Accepted socket connection from /127.0.0.1:38321
15/04/13 08:16:33 INFO server.ZooKeeperServer: Client attempting to establish new session at /127.0.0.1:38321
15/04/13 08:16:33 INFO persistence.FileTxnLog: Creating new log file: log.6a
15/04/13 08:16:33 INFO server.ZooKeeperServer: Established session 0x14cb1d9ce620000 with negotiated timeout 1200000 for client /127.0.0.1:38321
15/04/13 08:16:33 INFO zookeeper.ClientCnxn: Session establishment complete on server localhost/127.0.0.1:20000, sessionid = 0x14cb1d9ce620000, negotiated timeout = 1200000
15/04/13 08:16:33 INFO mortbay.log: Logging to org.slf4j.impl.Log4jLoggerAdapter(org.mortbay.log) via org.mortbay.log.Slf4jLog
15/04/13 08:16:33 INFO mortbay.log: Created master and client sync clients
15/04/13 08:16:33 INFO mortbay.log: BSP root exists
15/04/13 08:16:33 INFO zookeeper.ZooKeeper: Initiating client connection, connectString=localhost:20000 sessionTimeout=1200000 watcher=org.apache.hama.bsp.sync.ZooKeeperSyncClientImpl@f8093f
15/04/13 08:16:33 INFO sync.ZKSyncClient: Initializing ZK Sync Client
15/04/13 08:16:33 INFO zookeeper.ClientCnxn: Opening socket connection to server localhost/0:0:0:0:0:0:0:1:20000. Will not attempt to authenticate using SASL (unknown error)
15/04/13 08:16:33 INFO sync.ZooKeeperSyncClientImpl: Start connecting to Zookeeper! At /0.0.0.0:21815
15/04/13 08:16:33 INFO zookeeper.ClientCnxn: Socket connection established to localhost/0:0:0:0:0:0:0:1:20000, initiating session
15/04/13 08:16:33 INFO server.NIOServerCnxnFactory: Accepted socket connection from /0:0:0:0:0:0:0:1:33491
15/04/13 08:16:33 INFO server.ZooKeeperServer: Client attempting to establish new session at /0:0:0:0:0:0:0:1:33491
15/04/13 08:16:33 INFO server.ZooKeeperServer: Established session 0x14cb1d9ce620001 with negotiated timeout 1200000 for client /0:0:0:0:0:0:0:1:33491
15/04/13 08:16:33 INFO zookeeper.ClientCnxn: Session establishment complete on server localhost/0:0:0:0:0:0:0:1:20000, sessionid = 0x14cb1d9ce620001, negotiated timeout = 1200000
15/04/13 08:16:33 INFO sync.ZKSyncClient: Writing data /bsp/job_test1_0001/info/level2
15/04/13 08:16:33 INFO mortbay.log: Found child count = 2
15/04/13 08:16:33 INFO mortbay.log: Passed the child count test
15/04/13 08:16:33 INFO mortbay.log: Found child count = 2
15/04/13 08:16:33 INFO mortbay.log: Peer name 2
15/04/13 08:16:33 INFO mortbay.log: Peer name 1
15/04/13 08:16:33 INFO mortbay.log: Passed the child key set test
15/04/13 08:16:33 INFO mortbay.log: /bsp/job_test1_0001
15/04/13 08:16:34 INFO mortbay.log: Passed the key presence test
15/04/13 08:16:34 INFO sync.ZKSyncClient: Writing data /bsp/job_test1_0001/info/level3
15/04/13 08:16:34 INFO mortbay.log: Passed array writable test
15/04/13 08:16:34 INFO server.NIOServerCnxn: Closed socket connection for client /127.0.0.1:38321 which had sessionid 0x14cb1d9ce620000
15/04/13 08:16:34 INFO zookeeper.ClientCnxn: Unable to read additional data from server sessionid 0x14cb1d9ce620000, likely server has closed socket, closing socket connection and attempting reconnect
15/04/13 08:16:34 INFO server.NIOServerCnxn: Closed socket connection for client /0:0:0:0:0:0:0:1:33491 which had sessionid 0x14cb1d9ce620001
15/04/13 08:16:34 INFO zookeeper.ClientCnxn: Unable to read additional data from server sessionid 0x14cb1d9ce620001, likely server has closed socket, closing socket connection and attempting reconnect
15/04/13 08:16:34 INFO server.NIOServerCnxnFactory: NIOServerCnxn factory exited run method
15/04/13 08:16:34 INFO server.ZooKeeperServer: shutting down
15/04/13 08:16:34 INFO server.SessionTrackerImpl: Shutting down
15/04/13 08:16:34 INFO server.PrepRequestProcessor: Shutting down
15/04/13 08:16:34 INFO server.ZooKeeperServer: shutting down
15/04/13 08:16:34 INFO server.SessionTrackerImpl: Shutting down
15/04/13 08:16:34 INFO server.SyncRequestProcessor: Shutting down
15/04/13 08:16:34 INFO server.PrepRequestProcessor: Shutting down
15/04/13 08:16:34 INFO server.PrepRequestProcessor: PrepRequestProcessor exited loop!
15/04/13 08:16:34 INFO server.SyncRequestProcessor: Shutting down
15/04/13 08:16:34 INFO server.SyncRequestProcessor: SyncRequestProcessor exited!
15/04/13 08:16:34 INFO server.FinalRequestProcessor: shutdown of request processor complete
15/04/13 08:16:34 INFO server.FinalRequestProcessor: shutdown of request processor complete
15/04/13 08:16:34 WARN jmx.MBeanRegistry: Failed to unregister MBean InMemoryDataTree
15/04/13 08:16:34 WARN jmx.MBeanRegistry: Error during unregister
javax.management.InstanceNotFoundException: org.apache.ZooKeeperService:name0=StandaloneServer_port-1,name1=InMemoryDataTree
at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.getMBean(DefaultMBeanServerInterceptor.java:1095)
at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.exclusiveUnregisterMBean(DefaultMBeanServerInterceptor.java:427)
at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.unregisterMBean(DefaultMBeanServerInterceptor.java:415)
at com.sun.jmx.mbeanserver.JmxMBeanServer.unregisterMBean(JmxMBeanServer.java:546)
at org.apache.zookeeper.jmx.MBeanRegistry.unregister(MBeanRegistry.java:115)
at org.apache.zookeeper.jmx.MBeanRegistry.unregister(MBeanRegistry.java:132)
at org.apache.zookeeper.server.ZooKeeperServer.unregisterJMX(ZooKeeperServer.java:443)
at org.apache.zookeeper.server.ZooKeeperServer.shutdown(ZooKeeperServer.java:436)
at org.apache.zookeeper.server.NIOServerCnxnFactory.shutdown(NIOServerCnxnFactory.java:271)
at org.apache.zookeeper.server.ZooKeeperServerMain.shutdown(ZooKeeperServerMain.java:127)
at org.apache.hama.zookeeper.QuorumPeer$ShutdownableZooKeeperServerMain.shutdown(QuorumPeer.java:407)
at org.apache.hama.zookeeper.QuorumPeer$ShutdownableZooKeeperServerMain.shutdownZookeeperMain(QuorumPeer.java:402)
at org.apache.hama.bsp.sync.ZooKeeperSyncServerImpl.stopServer(ZooKeeperSyncServerImpl.java:88)
at org.apache.hama.bsp.TestZooKeeper.testClearZKNodes(TestZooKeeper.java:187)
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 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:232)
at junit.framework.TestSuite.run(TestSuite.java:227)
at org.junit.internal.runners.JUnit38ClassRunner.run(JUnit38ClassRunner.java:83)
at org.junit.runners.Suite.runChild(Suite.java:128)
at org.junit.runners.Suite.runChild(Suite.java:24)
at org.junit.runners.ParentRunner$3.run(ParentRunner.java:193)
at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:52)
at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:191)
at org.junit.runners.ParentRunner.access$000(ParentRunner.java:42)
at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:184)
at org.junit.runners.ParentRunner.run(ParentRunner.java:236)
at org.junit.runner.JUnitCore.run(JUnitCore.java:157)
at org.junit.runner.JUnitCore.run(JUnitCore.java:136)
at org.junit.runner.JUnitCore.run(JUnitCore.java:127)
at org.apache.maven.surefire.junitcore.JUnitCoreTestSet.runJunitCore(JUnitCoreTestSet.java:208)
at org.apache.maven.surefire.junitcore.JUnitCoreTestSet.execute(JUnitCoreTestSet.java:95)
at org.apache.maven.surefire.junitcore.JUnitCoreTestSet.execute(JUnitCoreTestSet.java:82)
at org.apache.maven.surefire.junitcore.JUnitCoreDirectoryTestSuite.execute(JUnitCoreDirectoryTestSuite.java:84)
at org.apache.maven.surefire.Surefire.run(Surefire.java:104)
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.apache.maven.surefire.booter.SurefireBooter.runSuitesInProcess(SurefireBooter.java:290)
at org.apache.maven.surefire.booter.SurefireBooter.main(SurefireBooter.java:1017)
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.015 sec
Results :
Failed tests:
Tests run: 56, Failures: 1, Errors: 0, Skipped: 0
[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO]
[INFO] Apache Hama parent POM ............................ SUCCESS [4.684s]
[INFO] pipes ............................................. SUCCESS [15.529s]
[INFO] commons ........................................... SUCCESS [6.528s]
[INFO] core .............................................. FAILURE [2:54.892s]
[INFO] graph ............................................. SKIPPED
[INFO] machine learning .................................. SKIPPED
[INFO] examples .......................................... SKIPPED
[INFO] mesos ............................................. SKIPPED
[INFO] hama-dist ......................................... SKIPPED
[INFO] ------------------------------------------------------------------------
[INFO] BUILD FAILURE
[INFO] ------------------------------------------------------------------------
[INFO] Total time: 3:22.340s
[INFO] Finished at: Mon Apr 13 08:16:34 UTC 2015
[INFO] Final Memory: 66M/526M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.6:test (default-test) on project hama-core: There are test failures.
[ERROR]
[ERROR] Please refer to <https://builds.apache.org/job/Hama-trunk/ws/trunk/core/target/surefire-reports> for the individual test results.
[ERROR] -> [Help 1]
[ERROR]
[ERROR] To see the full stack trace of the errors, re-run Maven with the -e switch.
[ERROR] Re-run Maven using the -X switch to enable full debug logging.
[ERROR]
[ERROR] For more information about the errors and possible solutions, please read the following articles:
[ERROR] [Help 1] http://cwiki.apache.org/confluence/display/MAVEN/MojoFailureException
[ERROR]
[ERROR] After correcting the problems, you can resume the build with the command
[ERROR] mvn <goals> -rf :hama-core
Build step 'Invoke top-level Maven targets' marked build as failure
Archiving artifacts
Sending artifact delta relative to Hama-trunk #367
Archived 149 artifacts
Archive block size is 32768
Received 3873 blocks and 351241 bytes
Compression is 99.7%
Took 19 sec
Recording test results
Updating HAMA-526
Build failed in Jenkins: Hama-trunk #369
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Hama-trunk/369/changes>
Changes:
[edwardyoon] HAMA-946: Improving graph package
------------------------------------------
[...truncated 4323 lines...]
15/04/13 01:16:29 INFO server.ZooKeeperServer: Server environment:user.dir=/tmp
15/04/13 01:16:29 INFO server.ZooKeeperServer: tickTime set to 3000
15/04/13 01:16:29 INFO server.ZooKeeperServer: minSessionTimeout set to -1
15/04/13 01:16:29 INFO server.ZooKeeperServer: maxSessionTimeout set to 1200000
15/04/13 01:16:29 INFO server.NIOServerCnxnFactory: binding to port 0.0.0.0/0.0.0.0:20000
15/04/13 01:16:29 INFO persistence.FileSnap: Reading snapshot /tmp/hama-testzookeeper/version-2/snapshot.42
15/04/13 01:16:29 INFO persistence.FileTxnSnapLog: Snapshotting: 0x47 to /tmp/hama-testzookeeper/version-2/snapshot.47
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:zookeeper.version=3.4.5-1392090, built on 09/30/2012 17:52 GMT
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:host.name=pomona.apache.org
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:java.version=1.7.0_25
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:java.vendor=Oracle Corporation
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:java.home=/home/jenkins/tools/java/jdk1.7.0_25-32/jre
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:java.class.path=/tmp/surefirebooter8232967723802590564.jar
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:java.library.path=/usr/java/packages/lib/i386:/lib:/usr/lib
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:java.io.tmpdir=/tmp
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:java.compiler=<NA>
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:os.name=Linux
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:os.arch=i386
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:os.version=3.13.0-36-lowlatency
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:user.name=jenkins
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:user.home=/home/jenkins
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Client environment:user.dir=/tmp
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Initiating client connection, connectString=localhost:20000 sessionTimeout=1200000 watcher=org.apache.hama.bsp.sync.ZKSyncBSPMasterClient@1734643
15/04/13 01:16:39 INFO sync.ZKSyncBSPMasterClient: Initialized ZK false
15/04/13 01:16:39 INFO sync.ZKSyncClient: Initializing ZK Sync Client
15/04/13 01:16:39 INFO zookeeper.ClientCnxn: Opening socket connection to server localhost/0:0:0:0:0:0:0:1:20000. Will not attempt to authenticate using SASL (unknown error)
15/04/13 01:16:39 INFO zookeeper.ClientCnxn: Socket connection established to localhost/0:0:0:0:0:0:0:1:20000, initiating session
15/04/13 01:16:39 INFO server.NIOServerCnxnFactory: Accepted socket connection from /0:0:0:0:0:0:0:1:44513
15/04/13 01:16:39 INFO server.ZooKeeperServer: Client attempting to establish new session at /0:0:0:0:0:0:0:1:44513
15/04/13 01:16:39 INFO persistence.FileTxnLog: Creating new log file: log.48
15/04/13 01:16:39 INFO server.ZooKeeperServer: Established session 0x14cb05960cb0000 with negotiated timeout 1200000 for client /0:0:0:0:0:0:0:1:44513
15/04/13 01:16:39 INFO zookeeper.ClientCnxn: Session establishment complete on server localhost/0:0:0:0:0:0:0:1:20000, sessionid = 0x14cb05960cb0000, negotiated timeout = 1200000
15/04/13 01:16:39 INFO mortbay.log: Logging to org.slf4j.impl.Log4jLoggerAdapter(org.mortbay.log) via org.mortbay.log.Slf4jLog
15/04/13 01:16:39 INFO mortbay.log: Created master and client sync clients
15/04/13 01:16:39 INFO mortbay.log: BSP root exists
15/04/13 01:16:39 INFO zookeeper.ZooKeeper: Initiating client connection, connectString=localhost:20000 sessionTimeout=1200000 watcher=org.apache.hama.bsp.sync.ZooKeeperSyncClientImpl@273cef
15/04/13 01:16:39 INFO sync.ZKSyncClient: Initializing ZK Sync Client
15/04/13 01:16:39 INFO zookeeper.ClientCnxn: Opening socket connection to server localhost/0:0:0:0:0:0:0:1:20000. Will not attempt to authenticate using SASL (unknown error)
15/04/13 01:16:39 INFO sync.ZooKeeperSyncClientImpl: Start connecting to Zookeeper! At /0.0.0.0:21815
15/04/13 01:16:39 INFO zookeeper.ClientCnxn: Socket connection established to localhost/0:0:0:0:0:0:0:1:20000, initiating session
15/04/13 01:16:39 INFO server.NIOServerCnxnFactory: Accepted socket connection from /0:0:0:0:0:0:0:1:44514
15/04/13 01:16:39 INFO server.ZooKeeperServer: Client attempting to establish new session at /0:0:0:0:0:0:0:1:44514
15/04/13 01:16:39 INFO server.ZooKeeperServer: Established session 0x14cb05960cb0001 with negotiated timeout 1200000 for client /0:0:0:0:0:0:0:1:44514
15/04/13 01:16:39 INFO zookeeper.ClientCnxn: Session establishment complete on server localhost/0:0:0:0:0:0:0:1:20000, sessionid = 0x14cb05960cb0001, negotiated timeout = 1200000
15/04/13 01:16:39 INFO sync.ZKSyncClient: Writing data /bsp/job_test1_0001/info/level2
15/04/13 01:16:39 INFO mortbay.log: Found child count = 2
15/04/13 01:16:39 INFO mortbay.log: Passed the child count test
15/04/13 01:16:39 INFO mortbay.log: Found child count = 2
15/04/13 01:16:39 INFO mortbay.log: Peer name 2
15/04/13 01:16:39 INFO mortbay.log: Peer name 1
15/04/13 01:16:39 INFO mortbay.log: Passed the child key set test
15/04/13 01:16:39 INFO mortbay.log: /bsp/job_test1_0001
15/04/13 01:16:40 INFO mortbay.log: Passed the key presence test
15/04/13 01:16:40 INFO sync.ZKSyncClient: Writing data /bsp/job_test1_0001/info/level3
15/04/13 01:16:40 INFO mortbay.log: Passed array writable test
15/04/13 01:16:40 INFO server.NIOServerCnxn: Closed socket connection for client /0:0:0:0:0:0:0:1:44513 which had sessionid 0x14cb05960cb0000
15/04/13 01:16:40 INFO zookeeper.ClientCnxn: Unable to read additional data from server sessionid 0x14cb05960cb0000, likely server has closed socket, closing socket connection and attempting reconnect
15/04/13 01:16:40 INFO server.NIOServerCnxn: Closed socket connection for client /0:0:0:0:0:0:0:1:44514 which had sessionid 0x14cb05960cb0001
15/04/13 01:16:40 INFO zookeeper.ClientCnxn: Unable to read additional data from server sessionid 0x14cb05960cb0001, likely server has closed socket, closing socket connection and attempting reconnect
15/04/13 01:16:40 INFO server.NIOServerCnxnFactory: NIOServerCnxn factory exited run method
15/04/13 01:16:40 INFO server.ZooKeeperServer: shutting down
15/04/13 01:16:40 INFO server.ZooKeeperServer: shutting down
15/04/13 01:16:40 INFO server.SessionTrackerImpl: Shutting down
15/04/13 01:16:40 INFO server.SessionTrackerImpl: Shutting down
15/04/13 01:16:40 INFO server.PrepRequestProcessor: Shutting down
15/04/13 01:16:40 INFO server.PrepRequestProcessor: Shutting down
15/04/13 01:16:40 INFO server.SyncRequestProcessor: Shutting down
15/04/13 01:16:40 INFO server.PrepRequestProcessor: PrepRequestProcessor exited loop!
15/04/13 01:16:40 INFO server.SyncRequestProcessor: SyncRequestProcessor exited!
15/04/13 01:16:40 INFO server.SyncRequestProcessor: Shutting down
15/04/13 01:16:40 INFO server.FinalRequestProcessor: shutdown of request processor complete
15/04/13 01:16:40 INFO server.FinalRequestProcessor: shutdown of request processor complete
15/04/13 01:16:40 WARN jmx.MBeanRegistry: Failed to unregister MBean InMemoryDataTree
15/04/13 01:16:40 WARN jmx.MBeanRegistry: Error during unregister
javax.management.InstanceNotFoundException: org.apache.ZooKeeperService:name0=StandaloneServer_port-1,name1=InMemoryDataTree
at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.getMBean(DefaultMBeanServerInterceptor.java:1095)
at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.exclusiveUnregisterMBean(DefaultMBeanServerInterceptor.java:427)
at com.sun.jmx.interceptor.DefaultMBeanServerInterceptor.unregisterMBean(DefaultMBeanServerInterceptor.java:415)
at com.sun.jmx.mbeanserver.JmxMBeanServer.unregisterMBean(JmxMBeanServer.java:546)
at org.apache.zookeeper.jmx.MBeanRegistry.unregister(MBeanRegistry.java:115)
at org.apache.zookeeper.jmx.MBeanRegistry.unregister(MBeanRegistry.java:132)
at org.apache.zookeeper.server.ZooKeeperServer.unregisterJMX(ZooKeeperServer.java:443)
at org.apache.zookeeper.server.ZooKeeperServer.shutdown(ZooKeeperServer.java:436)
at org.apache.zookeeper.server.NIOServerCnxnFactory.shutdown(NIOServerCnxnFactory.java:271)
at org.apache.zookeeper.server.ZooKeeperServerMain.shutdown(ZooKeeperServerMain.java:127)
at org.apache.hama.zookeeper.QuorumPeer$ShutdownableZooKeeperServerMain.shutdown(QuorumPeer.java:407)
at org.apache.hama.zookeeper.QuorumPeer$ShutdownableZooKeeperServerMain.shutdownZookeeperMain(QuorumPeer.java:402)
at org.apache.hama.bsp.sync.ZooKeeperSyncServerImpl.stopServer(ZooKeeperSyncServerImpl.java:88)
at org.apache.hama.bsp.TestZooKeeper.testClearZKNodes(TestZooKeeper.java:187)
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 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:232)
at junit.framework.TestSuite.run(TestSuite.java:227)
at org.junit.internal.runners.JUnit38ClassRunner.run(JUnit38ClassRunner.java:83)
at org.junit.runners.Suite.runChild(Suite.java:128)
at org.junit.runners.Suite.runChild(Suite.java:24)
at org.junit.runners.ParentRunner$3.run(ParentRunner.java:193)
at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:52)
at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:191)
at org.junit.runners.ParentRunner.access$000(ParentRunner.java:42)
at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:184)
at org.junit.runners.ParentRunner.run(ParentRunner.java:236)
at org.junit.runner.JUnitCore.run(JUnitCore.java:157)
at org.junit.runner.JUnitCore.run(JUnitCore.java:136)
at org.junit.runner.JUnitCore.run(JUnitCore.java:127)
at org.apache.maven.surefire.junitcore.JUnitCoreTestSet.runJunitCore(JUnitCoreTestSet.java:208)
at org.apache.maven.surefire.junitcore.JUnitCoreTestSet.execute(JUnitCoreTestSet.java:95)
at org.apache.maven.surefire.junitcore.JUnitCoreTestSet.execute(JUnitCoreTestSet.java:82)
at org.apache.maven.surefire.junitcore.JUnitCoreDirectoryTestSuite.execute(JUnitCoreDirectoryTestSuite.java:84)
at org.apache.maven.surefire.Surefire.run(Surefire.java:104)
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.apache.maven.surefire.booter.SurefireBooter.runSuitesInProcess(SurefireBooter.java:290)
at org.apache.maven.surefire.booter.SurefireBooter.main(SurefireBooter.java:1017)
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.013 sec
Results :
Failed tests:
Tests run: 56, Failures: 1, Errors: 0, Skipped: 0
[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO]
[INFO] Apache Hama parent POM ............................ SUCCESS [5.288s]
[INFO] pipes ............................................. SUCCESS [16.569s]
[INFO] commons ........................................... SUCCESS [6.489s]
[INFO] core .............................................. FAILURE [2:55.975s]
[INFO] graph ............................................. SKIPPED
[INFO] machine learning .................................. SKIPPED
[INFO] examples .......................................... SKIPPED
[INFO] mesos ............................................. SKIPPED
[INFO] hama-dist ......................................... SKIPPED
[INFO] ------------------------------------------------------------------------
[INFO] BUILD FAILURE
[INFO] ------------------------------------------------------------------------
[INFO] Total time: 3:25.174s
[INFO] Finished at: Mon Apr 13 01:16:40 UTC 2015
[INFO] Final Memory: 63M/400M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.6:test (default-test) on project hama-core: There are test failures.
[ERROR]
[ERROR] Please refer to <https://builds.apache.org/job/Hama-trunk/ws/trunk/core/target/surefire-reports> for the individual test results.
[ERROR] -> [Help 1]
[ERROR]
[ERROR] To see the full stack trace of the errors, re-run Maven with the -e switch.
[ERROR] Re-run Maven using the -X switch to enable full debug logging.
[ERROR]
[ERROR] For more information about the errors and possible solutions, please read the following articles:
[ERROR] [Help 1] http://cwiki.apache.org/confluence/display/MAVEN/MojoFailureException
[ERROR]
[ERROR] After correcting the problems, you can resume the build with the command
[ERROR] mvn <goals> -rf :hama-core
Build step 'Invoke top-level Maven targets' marked build as failure
Archiving artifacts
Sending artifact delta relative to Hama-trunk #367
Archived 149 artifacts
Archive block size is 32768
Received 3873 blocks and 351376 bytes
Compression is 99.7%
Took 13 sec
Recording test results
Updating HAMA-946