See <https://builds.apache.org/job/hbase-0.96/152/changes>
Changes: [apurtell] HBASE-9716. LoadTestTool should provide default min and max settings to the data generator ------------------------------------------ [...truncated 4261 lines...] Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.537 sec Running org.apache.hadoop.hbase.regionserver.TestMultiColumnScanner Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 36.771 sec Running org.apache.hadoop.hbase.regionserver.wal.TestLogRolling Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 863.716 sec Running org.apache.hadoop.hbase.regionserver.TestRegionServerMetrics Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 87.252 sec Running org.apache.hadoop.hbase.regionserver.TestHRegion Tests run: 64, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 118.886 sec Running org.apache.hadoop.hbase.regionserver.TestFSErrorsExposed Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 61.26 sec Running org.apache.hadoop.hbase.regionserver.TestCompactionWithCoprocessor Tests run: 18, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 51.586 sec Running org.apache.hadoop.hbase.regionserver.TestSplitLogWorker Tests run: 5, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: 10.801 sec <<< FAILURE! Running org.apache.hadoop.hbase.regionserver.TestRegionServerNoMaster Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 74.376 sec Running org.apache.hadoop.hbase.regionserver.TestAtomicOperation Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 35.602 sec Running org.apache.hadoop.hbase.regionserver.TestSeekOptimizations Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.077 sec Running org.apache.hadoop.hbase.regionserver.TestMasterAddressManager Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.259 sec Running org.apache.hadoop.hbase.regionserver.TestEndToEndSplitTransaction Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 68.204 sec Running org.apache.hadoop.hbase.TestClusterBootOrder Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 55.05 sec Results : Failed tests: testRescan(org.apache.hadoop.hbase.regionserver.TestSplitLogWorker): Waiting timed out after [1,500] msec Tests run: 1487, Failures: 1, Errors: 0, Skipped: 22 [INFO] ------------------------------------------------------------------------ [INFO] Reactor Summary: [INFO] [INFO] HBase ............................................. SUCCESS [5.153s] [INFO] HBase - Common .................................... SUCCESS [23.542s] [INFO] HBase - Protocol .................................. SUCCESS [8.799s] [INFO] HBase - Client .................................... SUCCESS [34.767s] [INFO] HBase - Hadoop Compatibility ...................... SUCCESS [5.421s] [INFO] HBase - Hadoop One Compatibility .................. SUCCESS [1.666s] [INFO] HBase - Prefix Tree ............................... SUCCESS [3.065s] [INFO] HBase - Server .................................... FAILURE [2:58:31.388s] [INFO] HBase - Testing Util .............................. SKIPPED [INFO] HBase - Thrift .................................... SKIPPED [INFO] HBase - Shell ..................................... SKIPPED [INFO] HBase - Integration Tests ......................... SKIPPED [INFO] HBase - Examples .................................. SKIPPED [INFO] HBase - Assembly .................................. SKIPPED [INFO] ------------------------------------------------------------------------ [INFO] BUILD FAILURE [INFO] ------------------------------------------------------------------------ [INFO] Total time: 2:59:54.797s [INFO] Finished at: Tue Oct 22 01:02:01 UTC 2013 [INFO] Final Memory: 69M/703M [INFO] ------------------------------------------------------------------------ [ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.12-TRUNK-HBASE-2:test (secondPartTestsExecution) on project hbase-server: Failure or timeout -> [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/MojoExecutionException [ERROR] [ERROR] After correcting the problems, you can resume the build with the command [ERROR] mvn <goals> -rf :hbase-server Build step 'Invoke top-level Maven targets' marked build as failure Performing Post build task... Match found for :.* : True Logical operation result is TRUE Running script : ZOMBIE_TESTS_COUNT=`jps | grep surefirebooter | wc -l` if [[ $ZOMBIE_TESTS_COUNT != 0 ]] ; then #It seems sometimes the tests are not dying immediately. Let's give them 10s echo "Suspicious java process found - waiting 10s to see if there are just slow to stop" sleep 10 ZOMBIE_TESTS_COUNT=`jps | grep surefirebooter | wc -l` if [[ $ZOMBIE_TESTS_COUNT != 0 ]] ; then echo "There are $ZOMBIE_TESTS_COUNT zombie tests, they should have been killed by surefire but survived" echo "************ BEGIN zombies jstack extract" ZB_STACK=`jps | grep surefirebooter | cut -d ' ' -f 1 | xargs -n 1 jstack | grep ".test" | grep "\.java"` jps | grep surefirebooter | cut -d ' ' -f 1 | xargs -n 1 jstack echo "************ END zombies jstack extract" JIRA_COMMENT="$JIRA_COMMENT {color:red}-1 core zombie tests{color}. There are ${ZOMBIE_TESTS_COUNT} zombie test(s): ${ZB_STACK}" BAD=1 jps | grep surefirebooter | cut -d ' ' -f 1 | xargs kill -9 else echo "We're ok: there is no zombie test, but some tests took some time to stop" fi else echo "We're ok: there is no zombie test" fi [hbase-0.96] $ /bin/bash -xe /tmp/hudson5394826244126958660.sh ++ jps ++ grep surefirebooter ++ wc -l + ZOMBIE_TESTS_COUNT=2 + [[ 2 != 0 ]] + echo 'Suspicious java process found - waiting 10s to see if there are just slow to stop' Suspicious java process found - waiting 10s to see if there are just slow to stop + sleep 10 ++ jps ++ grep surefirebooter ++ wc -l + ZOMBIE_TESTS_COUNT=1 + [[ 1 != 0 ]] + echo 'There are 1 zombie tests, they should have been killed by surefire but survived' There are 1 zombie tests, they should have been killed by surefire but survived + echo '************ BEGIN zombies jstack extract' ************ BEGIN zombies jstack extract ++ jps ++ grep surefirebooter ++ cut -d ' ' -f 1 ++ xargs -n 1 jstack ++ grep .test ++ grep '\.java' + ZB_STACK=' at org.apache.giraph.TestGraphPartitioner.testPartitioners(TestGraphPartitioner.java:126)' + jps + grep surefirebooter + cut -d ' ' -f 1 + xargs -n 1 jstack 2013-10-22 01:02:14 Full thread dump Java HotSpot(TM) Server VM (16.3-b01 mixed mode): "Attach Listener" daemon prio=10 tid=0xadd01800 nid=0xdac waiting on condition [0x00000000] java.lang.Thread.State: RUNNABLE "communication thread" daemon prio=10 tid=0xad3fc400 nid=0xd1a waiting on condition [0xaa97c000] java.lang.Thread.State: TIMED_WAITING (sleeping) at java.lang.Thread.sleep(Native Method) at org.apache.hadoop.mapred.Task$TaskReporter.run(Task.java:617) at java.lang.Thread.run(Thread.java:619) "Thread-52" prio=10 tid=0xad22b800 nid=0xd19 in Object.wait() [0xae769000] java.lang.Thread.State: WAITING (on object monitor) at java.lang.Object.wait(Native Method) - waiting on <0xb4e35400> (a java.lang.Object) at java.lang.Object.wait(Object.java:485) at org.apache.hadoop.mapred.Task$TaskReporter.stopCommunicationThread(Task.java:685) - locked <0xb4e35400> (a java.lang.Object) at org.apache.hadoop.mapred.Task.done(Task.java:802) at org.apache.hadoop.mapred.MapTask.run(MapTask.java:373) at org.apache.hadoop.mapred.LocalJobRunner$Job.run(LocalJobRunner.java:210) "Low Memory Detector" daemon prio=10 tid=0xadc08000 nid=0x6808 runnable [0x00000000] java.lang.Thread.State: RUNNABLE "CompilerThread1" daemon prio=10 tid=0xadc06400 nid=0x6807 waiting on condition [0x00000000] java.lang.Thread.State: RUNNABLE "CompilerThread0" daemon prio=10 tid=0xadc04400 nid=0x6806 waiting on condition [0x00000000] java.lang.Thread.State: RUNNABLE "Signal Dispatcher" daemon prio=10 tid=0xf68f9c00 nid=0x6805 runnable [0x00000000] java.lang.Thread.State: RUNNABLE "Finalizer" daemon prio=10 tid=0xf68ed000 nid=0x6804 in Object.wait() [0xaef7d000] java.lang.Thread.State: WAITING (on object monitor) at java.lang.Object.wait(Native Method) - waiting on <0xb37a6a40> (a java.lang.ref.ReferenceQueue$Lock) at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:118) - locked <0xb37a6a40> (a java.lang.ref.ReferenceQueue$Lock) at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:134) at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:159) "Reference Handler" daemon prio=10 tid=0xf68eb800 nid=0x6803 in Object.wait() [0xae1e7000] java.lang.Thread.State: WAITING (on object monitor) at java.lang.Object.wait(Native Method) - waiting on <0xb37a40d8> (a java.lang.ref.Reference$Lock) at java.lang.Object.wait(Object.java:485) at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:116) - locked <0xb37a40d8> (a java.lang.ref.Reference$Lock) "main" prio=10 tid=0xf6805800 nid=0x67f9 waiting on condition [0xf69f9000] java.lang.Thread.State: TIMED_WAITING (sleeping) at java.lang.Thread.sleep(Native Method) at org.apache.hadoop.mapred.JobClient.monitorAndPrintJob(JobClient.java:1234) at org.apache.hadoop.mapreduce.Job.waitForCompletion(Job.java:497) at org.apache.giraph.job.GiraphJob.run(GiraphJob.java:252) at org.apache.giraph.TestGraphPartitioner.testPartitioners(TestGraphPartitioner.java:126) at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39) at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25) at java.lang.reflect.Method.invoke(Method.java:597) at org.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:44) at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:15) at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:41) at org.junit.internal.runners.statements.InvokeMethod.evaluate(InvokeMethod.java:20) at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:28) at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:31) at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:76) at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50) 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.apache.maven.surefire.junit4.JUnit4TestSet.execute(JUnit4TestSet.java:59) at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.executeTestSet(AbstractDirectoryTestSuite.java:120) at org.apache.maven.surefire.suite.AbstractDirectoryTestSuite.execute(AbstractDirectoryTestSuite.java:103) at org.apache.maven.surefire.Surefire.run(Surefire.java:169) at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39) at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25) at java.lang.reflect.Method.invoke(Method.java:597) at org.apache.maven.surefire.booter.SurefireBooter.runSuitesInProcess(SurefireBooter.java:350) at org.apache.maven.surefire.booter.SurefireBooter.main(SurefireBooter.java:1021) "VM Thread" prio=10 tid=0xf68e8c00 nid=0x6802 runnable "GC task thread#0 (ParallelGC)" prio=10 tid=0xf680c800 nid=0x67fa runnable "GC task thread#1 (ParallelGC)" prio=10 tid=0xf680e000 nid=0x67fb runnable "GC task thread#2 (ParallelGC)" prio=10 tid=0xf680f800 nid=0x67fc runnable "GC task thread#3 (ParallelGC)" prio=10 tid=0xf6810c00 nid=0x67fd runnable "GC task thread#4 (ParallelGC)" prio=10 tid=0xf6812000 nid=0x67fe runnable "GC task thread#5 (ParallelGC)" prio=10 tid=0xf6813800 nid=0x67ff runnable "GC task thread#6 (ParallelGC)" prio=10 tid=0xf6814c00 nid=0x6800 runnable "GC task thread#7 (ParallelGC)" prio=10 tid=0xf6816400 nid=0x6801 runnable "VM Periodic Task Thread" prio=10 tid=0xadc11c00 nid=0x6809 waiting on condition JNI global references: 951 + echo '************ END zombies jstack extract' ************ END zombies jstack extract + JIRA_COMMENT=' {color:red}-1 core zombie tests{color}. There are 1 zombie test(s): at org.apache.giraph.TestGraphPartitioner.testPartitioners(TestGraphPartitioner.java:126)' + BAD=1 + jps + grep surefirebooter + cut -d ' ' -f 1 + xargs kill -9 POST BUILD TASK : SUCCESS END OF POST BUILD TASK : 0 Archiving artifacts Recording test results Updating HBASE-9716
