You are viewing a plain text version of this content. The canonical link for it is here.
Posted to builds@hbase.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2014/09/16 22:17:22 UTC

Build failed in Jenkins: HBase-TRUNK #5513

See <https://builds.apache.org/job/HBase-TRUNK/5513/changes>

Changes:

[stack] HBASE-11984 TestClassFinder failing on occasion FIX ATTEMPT

[enis] HBASE-11825 Create Connection and ConnectionManager (Solomon Duskis)

------------------------------------------
[...truncated 2991 lines...]
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x80e187b8> (a sun.nio.ch.Util$2)
	- locked <0x80e187a8> (a java.util.Collections$UnmodifiableSet)
	- locked <0x80e183a0> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener.run(Server.java:668)

"IPC Server Responder" daemon prio=10 tid=0x60754800 nid=0xc2c runnable [0x62dfe000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x80e191a0> (a sun.nio.ch.Util$2)
	- locked <0x80e19190> (a java.util.Collections$UnmodifiableSet)
	- locked <0x80e18f90> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.apache.hadoop.ipc.Server$Responder.doRunLoop(Server.java:835)
	at org.apache.hadoop.ipc.Server$Responder.run(Server.java:818)

"org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor@b6f0d6" daemon prio=10 tid=0x6074bc00 nid=0xc2b waiting on condition [0x628ad000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor.run(BlockManager.java:3336)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor@7d7f4d" daemon prio=10 tid=0x6074a000 nid=0xc2a waiting on condition [0x628fe000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor.run(HeartbeatManager.java:307)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor@593556" daemon prio=10 tid=0x60748800 nid=0xc29 waiting on condition [0x62d5c000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor.run(DecommissionManager.java:76)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor@17d02b5" daemon prio=10 tid=0x60747800 nid=0xc28 waiting on condition [0x62dad000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor.run(PendingReplicationBlocks.java:221)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.util.JvmPauseMonitor$Monitor@15fbed4" daemon prio=10 tid=0x60740c00 nid=0xc22 waiting on condition [0x6355c000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.util.JvmPauseMonitor$Monitor.run(JvmPauseMonitor.java:161)
	at java.lang.Thread.run(Thread.java:724)

"IPC Server idle connection scanner for port 37277" daemon prio=10 tid=0x6072b000 nid=0xc21 in Object.wait() [0x635ad000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x80e17d28> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Socket Reader #1 for port 37277" prio=10 tid=0x6070f000 nid=0xc20 runnable [0x635fe000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x80e167e8> (a sun.nio.ch.Util$2)
	- locked <0x80e167d8> (a java.util.Collections$UnmodifiableSet)
	- locked <0x80e14660> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener$Reader.doRunLoop(Server.java:616)
	- locked <0x80e18988> (a org.apache.hadoop.ipc.Server$Listener$Reader)
	at org.apache.hadoop.ipc.Server$Listener$Reader.run(Server.java:595)

"Timer-0" daemon prio=10 tid=0x60843c00 nid=0xb39 in Object.wait() [0x6427d000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7fd59ab8> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"9288993@qtp-7344580-1 - Acceptor0 SelectChannelConnector@localhost:46819" daemon prio=10 tid=0x60827c00 nid=0xad7 runnable [0x6447d000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x7fd8f9a0> (a sun.nio.ch.Util$2)
	- locked <0x7fd8f9b0> (a java.util.Collections$UnmodifiableSet)
	- locked <0x7fd8f960> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.mortbay.io.nio.SelectorManager$SelectSet.doSelect(SelectorManager.java:498)
	at org.mortbay.io.nio.SelectorManager.doSelect(SelectorManager.java:192)
	at org.mortbay.jetty.nio.SelectChannelConnector.accept(SelectChannelConnector.java:124)
	at org.mortbay.jetty.AbstractConnector$Acceptor.run(AbstractConnector.java:708)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:582)

"32089430@qtp-7344580-0" daemon prio=10 tid=0x60827400 nid=0xad6 in Object.wait() [0x64660000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:626)
	- locked <0x7fd8fda0> (a org.mortbay.thread.QueuedThreadPool$PoolThread)

"Timer for 'NameNode' metrics system" daemon prio=10 tid=0x60ad7000 nid=0xa91 in Object.wait() [0x6aa6c000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7fd90e40> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Service Thread" daemon prio=10 tid=0x64cf7000 nid=0x843 runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread1" daemon prio=10 tid=0x64cf5400 nid=0x842 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread0" daemon prio=10 tid=0x64cf3400 nid=0x841 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Signal Dispatcher" daemon prio=10 tid=0x64cf1800 nid=0x840 runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Finalizer" daemon prio=10 tid=0x64cb7000 nid=0x833 in Object.wait() [0x6be7d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:135)
	- locked <0x7cab8b70> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:151)
	at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:189)

"Reference Handler" daemon prio=10 tid=0x64cb5400 nid=0x832 in Object.wait() [0x6c07d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.Object.wait(Object.java:503)
	at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:133)
	- locked <0x7cada600> (a java.lang.ref.Reference$Lock)

"main" prio=10 tid=0xf6706800 nid=0x822 waiting on condition [0xf68ba000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hbase.client.ConnectionManager$HConnectionImplementation$StubMaker.makeStub(ConnectionManager.java:1499)
	- locked <0x821204b0> (a java.lang.Object)
	at org.apache.hadoop.hbase.client.ConnectionManager$HConnectionImplementation$MasterServiceStubMaker.makeStub(ConnectionManager.java:1534)
	at org.apache.hadoop.hbase.client.ConnectionManager$HConnectionImplementation.getKeepAliveMasterService(ConnectionManager.java:1739)
	- locked <0x821204b0> (a java.lang.Object)
	at org.apache.hadoop.hbase.client.HBaseAdmin$MasterCallable.prepare(HBaseAdmin.java:3569)
	at org.apache.hadoop.hbase.client.RpcRetryingCaller.callWithRetries(RpcRetryingCaller.java:110)
	at org.apache.hadoop.hbase.client.HBaseAdmin.executeCallable(HBaseAdmin.java:3596)
	at org.apache.hadoop.hbase.client.HBaseAdmin.createTableAsync(HBaseAdmin.java:611)
	at org.apache.hadoop.hbase.client.HBaseAdmin.createTable(HBaseAdmin.java:493)
	at org.apache.hadoop.hbase.client.HBaseAdmin.createTable(HBaseAdmin.java:425)
	at org.apache.hadoop.hbase.HBaseTestingUtility.createTable(HBaseTestingUtility.java:1189)
	at org.apache.hadoop.hbase.HBaseTestingUtility.createTable(HBaseTestingUtility.java:1206)
	at org.apache.hadoop.hbase.HBaseTestingUtility.createTable(HBaseTestingUtility.java:1140)
	at org.apache.hadoop.hbase.HBaseTestingUtility.createTable(HBaseTestingUtility.java:1086)
	at org.apache.hadoop.hbase.client.TestHCM.testClusterConnection(TestHCM.java:163)
	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.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:47)
	at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:12)
	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:44)
	at org.junit.internal.runners.statements.InvokeMethod.evaluate(InvokeMethod.java:17)
	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:271)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:70)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:26)
	at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:27)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runners.Suite.runChild(Suite.java:127)
	at org.junit.runners.Suite.runChild(Suite.java:26)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:160)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:138)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.createRequestAndRun(JUnitCoreWrapper.java:113)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.executeEager(JUnitCoreWrapper.java:85)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.execute(JUnitCoreWrapper.java:54)
	at org.apache.maven.surefire.junitcore.JUnitCoreProvider.invoke(JUnitCoreProvider.java:134)
	at org.apache.maven.surefire.booter.ForkedBooter.invokeProviderInSameClassLoader(ForkedBooter.java:200)
	at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:153)
	at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:103)

"VM Thread" prio=10 tid=0x64bf8800 nid=0x831 runnable 

"GC task thread#0 (ParallelGC)" prio=10 tid=0xf6710800 nid=0x823 runnable 

"GC task thread#1 (ParallelGC)" prio=10 tid=0xf6712000 nid=0x824 runnable 

"GC task thread#2 (ParallelGC)" prio=10 tid=0xf6713800 nid=0x825 runnable 

"GC task thread#3 (ParallelGC)" prio=10 tid=0xf6715000 nid=0x826 runnable 

"GC task thread#4 (ParallelGC)" prio=10 tid=0xf6716400 nid=0x827 runnable 

"GC task thread#5 (ParallelGC)" prio=10 tid=0xf6717c00 nid=0x828 runnable 

"GC task thread#6 (ParallelGC)" prio=10 tid=0xf6719400 nid=0x829 runnable 

"GC task thread#7 (ParallelGC)" prio=10 tid=0xf671a800 nid=0x82a runnable 

"GC task thread#8 (ParallelGC)" prio=10 tid=0xf671c000 nid=0x82b runnable 

"GC task thread#9 (ParallelGC)" prio=10 tid=0xf671d800 nid=0x82c runnable 

"GC task thread#10 (ParallelGC)" prio=10 tid=0xf671ec00 nid=0x82d runnable 

"GC task thread#11 (ParallelGC)" prio=10 tid=0xf6720400 nid=0x82e runnable 

"GC task thread#12 (ParallelGC)" prio=10 tid=0xf6721c00 nid=0x82f runnable 

"VM Periodic Task Thread" prio=10 tid=0x64cf9000 nid=0x844 waiting on condition 

JNI global references: 192

+ 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.hadoop.hbase.client.TestHCM.testClusterConnection(TestHCM.java:163)'
+ BAD=1
+ jps
+ grep surefirebooter
+ cut -d ' ' -f 1
+ xargs kill -9
POST BUILD TASK : SUCCESS
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1787 artifacts
Archive block size is 32768
Received 73 blocks and 811080672 bytes
Compression is 0.3%
Took 3 min 34 sec
Recording test results
Updating HBASE-11984
Updating HBASE-11825

Jenkins build is back to normal : HBase-TRUNK #5524

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5524/changes>


Build failed in Jenkins: HBase-TRUNK #5523

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5523/changes>

Changes:

[eclark] HBASE-12013 Support multiple regionservers per host in region_mover.rb

------------------------------------------
[...truncated 1616 lines...]
Running org.apache.hadoop.hbase.rest.TestScannersWithLabels
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.279 sec - in org.apache.hadoop.hbase.rest.TestStatusResource
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.806 sec - in org.apache.hadoop.hbase.rest.TestScannersWithLabels
Running org.apache.hadoop.hbase.rest.TestDeleteRow
Running org.apache.hadoop.hbase.rest.TestSchemaResource
Running org.apache.hadoop.hbase.rest.TestVersionResource
Running org.apache.hadoop.hbase.rest.TestScannersWithFilters
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.858 sec - in org.apache.hadoop.hbase.rest.TestVersionResource
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.981 sec - in org.apache.hadoop.hbase.rest.TestSchemaResource
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.047 sec - in org.apache.hadoop.hbase.rest.TestDeleteRow
Tests run: 10, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.612 sec - in org.apache.hadoop.hbase.rest.TestScannersWithFilters
Tests run: 18, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 20.259 sec - in org.apache.hadoop.hbase.rest.TestGetAndPutResource
Running org.apache.hadoop.hbase.rest.TestResourceFilter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.247 sec - in org.apache.hadoop.hbase.rest.TestResourceFilter
Running org.apache.hadoop.hbase.rest.client.TestRemoteTable
Running org.apache.hadoop.hbase.rest.TestMultiRowResource
Running org.apache.hadoop.hbase.rest.TestGzipFilter
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.422 sec - in org.apache.hadoop.hbase.rest.TestMultiRowResource
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.058 sec - in org.apache.hadoop.hbase.rest.TestGzipFilter
Running org.apache.hadoop.hbase.filter.TestFilterWrapper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.085 sec - in org.apache.hadoop.hbase.filter.TestFilterWrapper
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 14.146 sec - in org.apache.hadoop.hbase.rest.client.TestRemoteTable
Running org.apache.hadoop.hbase.filter.TestFuzzyRowAndColumnRangeFilter
Running org.apache.hadoop.hbase.filter.TestColumnRangeFilter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.114 sec - in org.apache.hadoop.hbase.filter.TestFuzzyRowAndColumnRangeFilter
Running org.apache.hadoop.hbase.rest.TestScannerResource
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 8.737 sec - in org.apache.hadoop.hbase.filter.TestColumnRangeFilter
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.448 sec - in org.apache.hadoop.hbase.rest.TestScannerResource
Running org.apache.hadoop.hbase.filter.TestFilterWithScanLimits
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.108 sec - in org.apache.hadoop.hbase.filter.TestFilterWithScanLimits
Running org.apache.hadoop.hbase.replication.TestReplicationStateZKImpl
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.891 sec - in org.apache.hadoop.hbase.replication.TestReplicationStateZKImpl
Running org.apache.hadoop.hbase.replication.TestReplicationWithTags
Running org.apache.hadoop.hbase.replication.TestReplicationKillMasterRS
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.191 sec - in org.apache.hadoop.hbase.replication.TestReplicationWithTags
Running org.apache.hadoop.hbase.replication.TestReplicationKillSlaveRS
Running org.apache.hadoop.hbase.replication.TestReplicationSyncUpTool
Running org.apache.hadoop.hbase.replication.TestReplicationDisableInactivePeer
Running org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpoint
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 19.895 sec - in org.apache.hadoop.hbase.replication.TestReplicationKillMasterRS
Running org.apache.hadoop.hbase.replication.regionserver.TestReplicationSourceManager
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.097 sec - in org.apache.hadoop.hbase.replication.TestReplicationKillSlaveRS
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.263 sec - in org.apache.hadoop.hbase.replication.regionserver.TestReplicationSourceManager
Running org.apache.hadoop.hbase.replication.regionserver.TestReplicationHLogReaderManager
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 19.999 sec - in org.apache.hadoop.hbase.replication.TestReplicationDisableInactivePeer
Running org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpointNoMaster
Running org.apache.hadoop.hbase.replication.regionserver.TestReplicationSink
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.818 sec - in org.apache.hadoop.hbase.replication.regionserver.TestReplicationSink
Running org.apache.hadoop.hbase.replication.TestReplicationSmallTests
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 48.072 sec - in org.apache.hadoop.hbase.replication.TestReplicationSyncUpTool
Running org.apache.hadoop.hbase.replication.TestReplicationChangingPeerRegionservers
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 36.198 sec - in org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpointNoMaster
Running org.apache.hadoop.hbase.replication.TestMultiSlaveReplication
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.599 sec - in org.apache.hadoop.hbase.replication.TestReplicationChangingPeerRegionservers
Running org.apache.hadoop.hbase.replication.TestMasterReplication
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 36.752 sec - in org.apache.hadoop.hbase.replication.TestReplicationSmallTests
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 19.916 sec - in org.apache.hadoop.hbase.replication.TestMultiSlaveReplication
Running org.apache.hadoop.hbase.replication.TestReplicationTrackerZKImpl
Tests run: 4, Failures: 0, Errors: 0, Skipped: 2, Time elapsed: 0.97 sec - in org.apache.hadoop.hbase.replication.TestReplicationTrackerZKImpl
Running org.apache.hadoop.hbase.replication.TestReplicationEndpoint
Running org.apache.hadoop.hbase.replication.TestReplicationKillMasterRSCompressed
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.56 sec - in org.apache.hadoop.hbase.replication.TestReplicationEndpoint
Tests run: 7, Failures: 0, Errors: 1, Skipped: 0, Time elapsed: 100.242 sec <<< FAILURE! - in org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpoint
testRegionReplicaReplicationWith3Replicas(org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpoint)  Time elapsed: 60.07 sec  <<< ERROR!
java.lang.Exception: test timed out after 60000 milliseconds
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hbase.Waiter.waitFor(Waiter.java:181)
	at org.apache.hadoop.hbase.Waiter.waitFor(Waiter.java:128)
	at org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpoint.verifyReplication(TestRegionReplicaReplicationEndpoint.java:192)
	at org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpoint.testRegionReplicaReplication(TestRegionReplicaReplicationEndpoint.java:162)
	at org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpoint.testRegionReplicaReplicationWith3Replicas(TestRegionReplicaReplicationEndpoint.java:217)

Running org.apache.hadoop.hbase.replication.TestReplicationSource
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.448 sec - in org.apache.hadoop.hbase.replication.TestReplicationSource
Running org.apache.hadoop.hbase.fs.TestBlockReorder
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 46.141 sec - in org.apache.hadoop.hbase.replication.TestMasterReplication
Running org.apache.hadoop.hbase.master.cleaner.TestLogsCleaner
Running org.apache.hadoop.hbase.replication.TestPerTableCFReplication
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 18.329 sec - in org.apache.hadoop.hbase.replication.TestReplicationKillMasterRSCompressed
Running org.apache.hadoop.hbase.master.cleaner.TestHFileCleaner
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.279 sec - in org.apache.hadoop.hbase.master.cleaner.TestLogsCleaner
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.944 sec - in org.apache.hadoop.hbase.master.cleaner.TestHFileCleaner
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 21.993 sec - in org.apache.hadoop.hbase.fs.TestBlockReorder
Running org.apache.hadoop.hbase.master.TestMasterRestartAfterDisablingTable
Running org.apache.hadoop.hbase.master.cleaner.TestSnapshotFromMaster
Running org.apache.hadoop.hbase.master.TestRegionPlacement
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.352 sec - in org.apache.hadoop.hbase.replication.TestPerTableCFReplication
Running org.apache.hadoop.hbase.master.TestClusterStatusPublisher
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.467 sec - in org.apache.hadoop.hbase.master.TestClusterStatusPublisher
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 10.582 sec - in org.apache.hadoop.hbase.master.cleaner.TestSnapshotFromMaster
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 14.692 sec - in org.apache.hadoop.hbase.master.TestMasterRestartAfterDisablingTable
Running org.apache.hadoop.hbase.master.handler.TestCreateTableHandler
Running org.apache.hadoop.hbase.master.handler.TestTableDescriptorModification
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 17.29 sec - in org.apache.hadoop.hbase.master.TestRegionPlacement
Running org.apache.hadoop.hbase.master.handler.TestTableDeleteFamilyHandler
Running org.apache.hadoop.hbase.master.TestRestartCluster
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.888 sec - in org.apache.hadoop.hbase.master.handler.TestTableDeleteFamilyHandler
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.903 sec - in org.apache.hadoop.hbase.master.handler.TestTableDescriptorModification
Running org.apache.hadoop.hbase.master.TestMasterNoCluster
Running org.apache.hadoop.hbase.master.TestAssignmentListener
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 18.773 sec - in org.apache.hadoop.hbase.master.handler.TestCreateTableHandler
Running org.apache.hadoop.hbase.master.TestDeadServer
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.316 sec - in org.apache.hadoop.hbase.master.TestDeadServer
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.912 sec - in org.apache.hadoop.hbase.master.TestAssignmentListener
Running org.apache.hadoop.hbase.master.balancer.TestBaseLoadBalancer
Running org.apache.hadoop.hbase.master.balancer.TestStochasticLoadBalancer
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 14.434 sec - in org.apache.hadoop.hbase.master.TestMasterNoCluster
Running org.apache.hadoop.hbase.master.balancer.TestDefaultLoadBalancer
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.265 sec - in org.apache.hadoop.hbase.master.balancer.TestDefaultLoadBalancer
Running org.apache.hadoop.hbase.master.TestSplitLogManager
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 29.932 sec - in org.apache.hadoop.hbase.master.TestRestartCluster
Running org.apache.hadoop.hbase.master.TestRollingRestart
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 19.474 sec - in org.apache.hadoop.hbase.master.TestRollingRestart
Running org.apache.hadoop.hbase.master.TestMasterFileSystem
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.342 sec - in org.apache.hadoop.hbase.master.TestMasterFileSystem
Running org.apache.hadoop.hbase.master.TestMasterTransitions
Tests run: 3, Failures: 0, Errors: 0, Skipped: 3, Time elapsed: 1.559 sec - in org.apache.hadoop.hbase.master.TestMasterTransitions
Running org.apache.hadoop.hbase.master.TestDistributedLogSplitting
Tests run: 15, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: 75.783 sec <<< FAILURE! - in org.apache.hadoop.hbase.master.TestSplitLogManager
testGetPreviousRecoveryMode(org.apache.hadoop.hbase.master.TestSplitLogManager)  Time elapsed: 0.134 sec  <<< FAILURE!
java.lang.AssertionError: null
	at org.junit.Assert.fail(Assert.java:86)
	at org.junit.Assert.assertTrue(Assert.java:41)
	at org.junit.Assert.assertTrue(Assert.java:52)
	at org.apache.hadoop.hbase.master.TestSplitLogManager.testGetPreviousRecoveryMode(TestSplitLogManager.java:651)

Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 243.244 sec - in org.apache.hadoop.hbase.replication.regionserver.TestReplicationHLogReaderManager
Running org.apache.hadoop.hbase.master.TestMasterFailover
Running org.apache.hadoop.hbase.master.TestAssignmentManagerOnCluster
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.996 sec - in org.apache.hadoop.hbase.master.TestMasterFailover
Running org.apache.hadoop.hbase.master.snapshot.TestSnapshotFileCache
Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 136.404 sec - in org.apache.hadoop.hbase.master.balancer.TestBaseLoadBalancer
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 17.269 sec - in org.apache.hadoop.hbase.master.snapshot.TestSnapshotFileCache
Running org.apache.hadoop.hbase.master.TestMaster
Running org.apache.hadoop.hbase.master.TestMasterMetrics
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.124 sec - in org.apache.hadoop.hbase.master.TestMasterMetrics
Running org.apache.hadoop.hbase.master.TestMasterFailoverBalancerPersistence
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.23 sec - in org.apache.hadoop.hbase.master.TestMaster
Running org.apache.hadoop.hbase.master.TestMasterShutdown
Tests run: 19, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 61.247 sec - in org.apache.hadoop.hbase.master.TestAssignmentManagerOnCluster
Running org.apache.hadoop.hbase.master.TestMasterStatusServlet
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.54 sec - in org.apache.hadoop.hbase.master.TestMasterStatusServlet
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.275 sec - in org.apache.hadoop.hbase.master.TestMasterFailoverBalancerPersistence
Running org.apache.hadoop.hbase.master.TestMasterOperationsForRegionReplicas
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 13.275 sec - in org.apache.hadoop.hbase.master.TestMasterShutdown
Running org.apache.hadoop.hbase.master.TestHMasterRPCException
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.737 sec - in org.apache.hadoop.hbase.master.TestHMasterRPCException
Running org.apache.hadoop.hbase.master.TestTableLockManager
Running org.apache.hadoop.hbase.master.TestMasterMetricsWrapper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.881 sec - in org.apache.hadoop.hbase.master.TestMasterMetricsWrapper
Running org.apache.hadoop.hbase.master.TestActiveMasterManager
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.4 sec - in org.apache.hadoop.hbase.master.TestMasterOperationsForRegionReplicas
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.215 sec - in org.apache.hadoop.hbase.master.TestActiveMasterManager
Tests run: 17, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 140.068 sec - in org.apache.hadoop.hbase.master.TestDistributedLogSplitting
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 78.215 sec - in org.apache.hadoop.hbase.master.TestTableLockManager
Tests run: 23, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 551.128 sec - in org.apache.hadoop.hbase.master.balancer.TestStochasticLoadBalancer

Results :

Failed tests: 
  TestSplitLogManager.testGetPreviousRecoveryMode:651 null

Tests in error: 
  TestRegionReplicaReplicationEndpoint.testRegionReplicaReplicationWith3Replicas:217->testRegionReplicaReplication:162->verifyReplication:192 ? 

Tests run: 1925, Failures: 1, Errors: 1, Skipped: 19

[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO] 
[INFO] HBase ............................................. SUCCESS [2.473s]
[INFO] HBase - Common .................................... SUCCESS [59.459s]
[INFO] HBase - Protocol .................................. SUCCESS [9.012s]
[INFO] HBase - Client .................................... SUCCESS [1:05.989s]
[INFO] HBase - Hadoop Compatibility ...................... SUCCESS [7.140s]
[INFO] HBase - Hadoop Two Compatibility .................. SUCCESS [6.119s]
[INFO] HBase - Prefix Tree ............................... SUCCESS [8.729s]
[INFO] HBase - Server .................................... FAILURE [1:02:07.098s]
[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: 1:04:46.769s
[INFO] Finished at: Thu Sep 18 17:10:35 UTC 2014
[INFO] Final Memory: 40M/306M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.17:test (secondPartTestsExecution) on project hbase-server: ExecutionException: java.lang.RuntimeException: The forked VM terminated without properly saying goodbye. VM crash or System.exit called?
[ERROR] Command was /bin/sh -c cd <https://builds.apache.org/job/HBase-TRUNK/ws/hbase-server> && /home/jenkins/tools/java/jdk1.7.0_25-32/jre/bin/java -enableassertions -XX:MaxDirectMemorySize=1G -Xmx1900m -XX:MaxPermSize=256m -Djava.security.egd=file:/dev/./urandom -Djava.net.preferIPv4Stack=true -Djava.awt.headless=true -jar <https://builds.apache.org/job/HBase-TRUNK/ws/hbase-server/target/surefire/surefirebooter7610807787737052399.jar> <https://builds.apache.org/job/HBase-TRUNK/ws/hbase-server/target/surefire/surefire5499494346562319022tmp> <https://builds.apache.org/job/HBase-TRUNK/ws/hbase-server/target/surefire/surefire_9441144181162440222430tmp>
[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 :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-TRUNK] $ /bin/bash -xe /tmp/hudson5005541395950598078.sh
++ jps
++ grep surefirebooter
++ wc -l
+ ZOMBIE_TESTS_COUNT=0
+ [[ 0 != 0 ]]
+ echo 'We'\''re ok: there is no zombie test'
We're ok: there is no zombie test
POST BUILD TASK : SUCCESS
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1780 artifacts
Archive block size is 32768
Received 73 blocks and 552227916 bytes
Compression is 0.4%
Took 2 min 41 sec
Recording test results
Updating HBASE-12013

Build failed in Jenkins: HBase-TRUNK #5522

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5522/changes>

Changes:

[anoopsamjohn] HBASE-11874 Support Cell to be passed to StoreFile.Writer rather than KeyValue.

------------------------------------------
[...truncated 24180 lines...]
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1130)
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
	at java.lang.Thread.run(Thread.java:724)

"pool-1-thread-1" prio=10 tid=0x63c64400 nid=0x3974 waiting on condition [0x64b63000]
   java.lang.Thread.State: WAITING (parking)
	at sun.misc.Unsafe.park(Native Method)
	- parking to wait for  <0x7d2d11c0> (a java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject)
	at java.util.concurrent.locks.LockSupport.park(LockSupport.java:186)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2043)
	at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442)
	at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1068)
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1130)
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
	at java.lang.Thread.run(Thread.java:724)

"process reaper" daemon prio=10 tid=0x64a1c400 nid=0x3850 waiting on condition [0x6522c000]
   java.lang.Thread.State: TIMED_WAITING (parking)
	at sun.misc.Unsafe.park(Native Method)
	- parking to wait for  <0x7d161e80> (a java.util.concurrent.SynchronousQueue$TransferStack)
	at java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:226)
	at java.util.concurrent.SynchronousQueue$TransferStack.awaitFulfill(SynchronousQueue.java:460)
	at java.util.concurrent.SynchronousQueue$TransferStack.transfer(SynchronousQueue.java:359)
	at java.util.concurrent.SynchronousQueue.poll(SynchronousQueue.java:942)
	at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1068)
	at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1130)
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
	at java.lang.Thread.run(Thread.java:724)

"Service Thread" daemon prio=10 tid=0x660e9000 nid=0x3821 runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread1" daemon prio=10 tid=0x660e7400 nid=0x3820 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread0" daemon prio=10 tid=0x660e5400 nid=0x381f waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Signal Dispatcher" daemon prio=10 tid=0x660e3800 nid=0x381c runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Finalizer" daemon prio=10 tid=0x660a8000 nid=0x3819 in Object.wait() [0x66152000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	- waiting on <0x7d17e590> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:135)
	- locked <0x7d17e590> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:151)
	at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:189)

"Reference Handler" daemon prio=10 tid=0x660a6000 nid=0x3818 in Object.wait() [0x6bd7d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	- waiting on <0x7d17e2e8> (a java.lang.ref.Reference$Lock)
	at java.lang.Object.wait(Object.java:503)
	at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:133)
	- locked <0x7d17e2e8> (a java.lang.ref.Reference$Lock)

"main" prio=10 tid=0xf6706800 nid=0x3812 waiting on condition [0xf690c000]
   java.lang.Thread.State: WAITING (parking)
	at sun.misc.Unsafe.park(Native Method)
	- parking to wait for  <0x7d8ed4d8> (a java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject)
	at java.util.concurrent.locks.LockSupport.park(LockSupport.java:186)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2043)
	at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442)
	at java.util.concurrent.ExecutorCompletionService.take(ExecutorCompletionService.java:193)
	at org.apache.hadoop.hbase.io.hfile.TestHFileBlock.testConcurrentReadingInternals(TestHFileBlock.java:740)
	at org.apache.hadoop.hbase.io.hfile.TestHFileBlock.testConcurrentReading(TestHFileBlock.java:708)
	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.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:47)
	at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:12)
	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:44)
	at org.junit.internal.runners.statements.InvokeMethod.evaluate(InvokeMethod.java:17)
	at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:26)
	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:271)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:70)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runners.Suite.runChild(Suite.java:127)
	at org.junit.runners.Suite.runChild(Suite.java:26)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runners.Suite.runChild(Suite.java:127)
	at org.junit.runners.Suite.runChild(Suite.java:26)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:160)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:138)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.createRequestAndRun(JUnitCoreWrapper.java:113)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.executeEager(JUnitCoreWrapper.java:85)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.execute(JUnitCoreWrapper.java:54)
	at org.apache.maven.surefire.junitcore.JUnitCoreProvider.invoke(JUnitCoreProvider.java:134)
	at org.apache.maven.surefire.booter.ForkedBooter.invokeProviderInSameClassLoader(ForkedBooter.java:200)
	at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:153)
	at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:103)

"VM Thread" prio=10 tid=0x660a0800 nid=0x3817 runnable 

"GC task thread#0 (ParallelGC)" prio=10 tid=0xf6710800 nid=0x3813 runnable 

"GC task thread#1 (ParallelGC)" prio=10 tid=0xf6712000 nid=0x3814 runnable 

"GC task thread#2 (ParallelGC)" prio=10 tid=0xf6713800 nid=0x3815 runnable 

"GC task thread#3 (ParallelGC)" prio=10 tid=0xf6714c00 nid=0x3816 runnable 

"VM Periodic Task Thread" prio=10 tid=0x660eac00 nid=0x3822 waiting on condition 

JNI global references: 232

2014-09-18 13:28:49
Full thread dump Java HotSpot(TM) Server VM (23.25-b01 mixed mode):

"Attach Listener" daemon prio=10 tid=0x65e03c00 nid=0x3ec2 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Service Thread" daemon prio=10 tid=0x65fe9000 nid=0x240b runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread1" daemon prio=10 tid=0x65fe7400 nid=0x240a waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread0" daemon prio=10 tid=0x65fe5400 nid=0x2409 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Signal Dispatcher" daemon prio=10 tid=0x65fe3800 nid=0x2408 runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Finalizer" daemon prio=10 tid=0x65fa8000 nid=0x2400 in Object.wait() [0x6be7d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	- waiting on <0x7ce0c990> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:135)
	- locked <0x7ce0c990> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:151)
	at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:189)

"Reference Handler" daemon prio=10 tid=0x65fa6000 nid=0x23ff in Object.wait() [0x6c07d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	- waiting on <0x7ce0c6c0> (a java.lang.ref.Reference$Lock)
	at java.lang.Object.wait(Object.java:503)
	at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:133)
	- locked <0x7ce0c6c0> (a java.lang.ref.Reference$Lock)

"main" prio=10 tid=0xf6706800 nid=0x23f4 runnable [0xf68a5000]
   java.lang.Thread.State: RUNNABLE
	at org.apache.hadoop.hbase.io.encoding.BufferedDataBlockEncoder$BufferedEncodedSeeker.seekToKeyInBlock(BufferedDataBlockEncoder.java:776)
	at org.apache.hadoop.hbase.io.encoding.TestDataBlockEncoders.checkSeekingConsistency(TestDataBlockEncoders.java:325)
	at org.apache.hadoop.hbase.io.encoding.TestDataBlockEncoders.testSeekingOnSample(TestDataBlockEncoders.java:205)
	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.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:47)
	at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:12)
	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:44)
	at org.junit.internal.runners.statements.InvokeMethod.evaluate(InvokeMethod.java:17)
	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:271)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:70)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runners.Suite.runChild(Suite.java:127)
	at org.junit.runners.Suite.runChild(Suite.java:26)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runners.Suite.runChild(Suite.java:127)
	at org.junit.runners.Suite.runChild(Suite.java:26)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:160)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:138)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.createRequestAndRun(JUnitCoreWrapper.java:113)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.executeEager(JUnitCoreWrapper.java:85)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.execute(JUnitCoreWrapper.java:54)
	at org.apache.maven.surefire.junitcore.JUnitCoreProvider.invoke(JUnitCoreProvider.java:134)
	at org.apache.maven.surefire.booter.ForkedBooter.invokeProviderInSameClassLoader(ForkedBooter.java:200)
	at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:153)
	at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:103)

"VM Thread" prio=10 tid=0x65fa0800 nid=0x23fe runnable 

"GC task thread#0 (ParallelGC)" prio=10 tid=0xf6710800 nid=0x23f6 runnable 

"GC task thread#1 (ParallelGC)" prio=10 tid=0xf6712000 nid=0x23f9 runnable 

"GC task thread#2 (ParallelGC)" prio=10 tid=0xf6713800 nid=0x23fa runnable 

"GC task thread#3 (ParallelGC)" prio=10 tid=0xf6714c00 nid=0x23fc runnable 

"VM Periodic Task Thread" prio=10 tid=0x65feac00 nid=0x240c waiting on condition 

JNI global references: 195

+ echo '************ END  zombies jstack extract'
************ END  zombies jstack extract
+ JIRA_COMMENT='

     {color:red}-1 core zombie tests{color}.  There are 4 zombie test(s): 	at org.apache.hadoop.hbase.io.hfile.TestCacheOnWrite.testNotCachingDataBlocksDuringCompactionInternals(TestCacheOnWrite.java:432)
	at org.apache.hadoop.hbase.io.hfile.TestCacheOnWrite.testNotCachingDataBlocksDuringCompaction(TestCacheOnWrite.java:385)
	at org.apache.hadoop.hbase.io.encoding.TestEncodedSeekers.testEncodedSeeker(TestEncodedSeekers.java:121)
	at org.apache.hadoop.hbase.io.hfile.TestHFileBlock.testConcurrentReadingInternals(TestHFileBlock.java:740)
	at org.apache.hadoop.hbase.io.hfile.TestHFileBlock.testConcurrentReading(TestHFileBlock.java:708)
	at org.apache.hadoop.hbase.io.encoding.TestDataBlockEncoders.testSeekingOnSample(TestDataBlockEncoders.java:205)'
+ BAD=1
+ grep surefirebooter
+ jps
+ cut -d ' ' -f 1
+ xargs kill -9
POST BUILD TASK : SUCCESS
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1016 artifacts
Archive block size is 32768
Received 8 blocks and 43385323 bytes
Compression is 0.6%
Took 42 sec
Recording test results
Updating HBASE-11874

Build failed in Jenkins: HBase-TRUNK #5521

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5521/changes>

Changes:

[mstanleyjones] Addendum to HBASE-11951 -- actually add the script

------------------------------------------
[...truncated 1718 lines...]
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 152.145 sec - in org.apache.hadoop.hbase.client.TestRestoreSnapshotFromClientWithRegionReplicas
Tests run: 79, Failures: 0, Errors: 0, Skipped: 4, Time elapsed: 188.444 sec - in org.apache.hadoop.hbase.client.TestFromClientSide
Running org.apache.hadoop.hbase.client.TestFromClientSide3
Running org.apache.hadoop.hbase.client.TestRestoreSnapshotFromClient
Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 112.565 sec - in org.apache.hadoop.hbase.client.TestReplicasClient
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 87.806 sec - in org.apache.hadoop.hbase.client.TestTableSnapshotScanner
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 65.519 sec - in org.apache.hadoop.hbase.client.TestFromClientSide3
Running org.apache.hadoop.hbase.client.TestSnapshotMetadata
Running org.apache.hadoop.hbase.TestMultiVersions
Running org.apache.hadoop.hbase.TestHColumnDescriptorDefaultVersions
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.636 sec - in org.apache.hadoop.hbase.TestMultiVersions
Running org.apache.hadoop.hbase.procedure.TestZKProcedure
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 34.137 sec - in org.apache.hadoop.hbase.client.TestSnapshotMetadata
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 19.982 sec - in org.apache.hadoop.hbase.TestHColumnDescriptorDefaultVersions
Running org.apache.hadoop.hbase.procedure.TestZKProcedureControllers
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.133 sec - in org.apache.hadoop.hbase.procedure.TestZKProcedure
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.091 sec - in org.apache.hadoop.hbase.procedure.TestZKProcedureControllers
Running org.apache.hadoop.hbase.constraint.TestConstraint
Running org.apache.hadoop.hbase.TestNamespace
Running org.apache.hadoop.hbase.rest.TestDeleteRow
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.269 sec - in org.apache.hadoop.hbase.constraint.TestConstraint
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.041 sec - in org.apache.hadoop.hbase.rest.TestDeleteRow
Tests run: 9, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 16.678 sec - in org.apache.hadoop.hbase.TestNamespace
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 140.186 sec - in org.apache.hadoop.hbase.client.TestRestoreSnapshotFromClient
Running org.apache.hadoop.hbase.rest.TestScannersWithLabels
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.377 sec - in org.apache.hadoop.hbase.rest.TestScannersWithLabels
Running org.apache.hadoop.hbase.rest.TestSchemaResource
Running org.apache.hadoop.hbase.rest.TestTableResource
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 8.872 sec - in org.apache.hadoop.hbase.rest.TestSchemaResource
Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.912 sec - in org.apache.hadoop.hbase.rest.TestTableResource
Running org.apache.hadoop.hbase.rest.TestTableScan
Running org.apache.hadoop.hbase.rest.TestGetAndPutResource
Running org.apache.hadoop.hbase.rest.TestStatusResource
Running org.apache.hadoop.hbase.rest.TestResourceFilter
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.815 sec - in org.apache.hadoop.hbase.rest.TestStatusResource
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.414 sec - in org.apache.hadoop.hbase.rest.TestResourceFilter
Tests run: 10, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 26.485 sec - in org.apache.hadoop.hbase.rest.TestTableScan
Running org.apache.hadoop.hbase.rest.client.TestRemoteTable
Tests run: 18, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 45.346 sec - in org.apache.hadoop.hbase.rest.TestGetAndPutResource
Running org.apache.hadoop.hbase.rest.TestVersionResource
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.208 sec - in org.apache.hadoop.hbase.rest.TestVersionResource
Running org.apache.hadoop.hbase.rest.TestMultiRowResource
Running org.apache.hadoop.hbase.rest.TestScannersWithFilters
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 30.895 sec - in org.apache.hadoop.hbase.rest.client.TestRemoteTable
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.395 sec - in org.apache.hadoop.hbase.rest.TestMultiRowResource
Tests run: 10, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.442 sec - in org.apache.hadoop.hbase.rest.TestScannersWithFilters
Running org.apache.hadoop.hbase.TestZooKeeper
Running org.apache.hadoop.hbase.rest.TestGzipFilter
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.801 sec - in org.apache.hadoop.hbase.rest.TestGzipFilter
Running org.apache.hadoop.hbase.rest.TestScannerResource
Running org.apache.hadoop.hbase.snapshot.TestFlushSnapshotFromClient
Running org.apache.hadoop.hbase.snapshot.TestExportSnapshot
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.871 sec - in org.apache.hadoop.hbase.rest.TestScannerResource
Running org.apache.hadoop.hbase.snapshot.TestSecureExportSnapshot
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 91.537 sec - in org.apache.hadoop.hbase.snapshot.TestFlushSnapshotFromClient
Running org.apache.hadoop.hbase.snapshot.TestRestoreFlushSnapshotFromClient
Tests run: 11, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: 239.335 sec <<< FAILURE! - in org.apache.hadoop.hbase.TestZooKeeper
testRegionAssignmentAfterMasterRecoveryDueToZKExpiry(org.apache.hadoop.hbase.TestZooKeeper)  Time elapsed: 52.362 sec  <<< FAILURE!
java.lang.AssertionError: expected:<17> but was:<16>
	at org.junit.Assert.fail(Assert.java:88)
	at org.junit.Assert.failNotEquals(Assert.java:743)
	at org.junit.Assert.assertEquals(Assert.java:118)
	at org.junit.Assert.assertEquals(Assert.java:555)
	at org.junit.Assert.assertEquals(Assert.java:542)
	at org.apache.hadoop.hbase.TestZooKeeper.testRegionAssignmentAfterMasterRecoveryDueToZKExpiry(TestZooKeeper.java:518)

Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 90.729 sec - in org.apache.hadoop.hbase.snapshot.TestRestoreFlushSnapshotFromClient
Running org.apache.hadoop.hbase.snapshot.TestSnapshotDescriptionUtils
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.618 sec - in org.apache.hadoop.hbase.snapshot.TestSnapshotDescriptionUtils
Running org.apache.hadoop.hbase.TestIOFencing
Running org.apache.hadoop.hbase.coprocessor.TestRegionObserverScannerOpenHook
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.39 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionObserverScannerOpenHook
Running org.apache.hadoop.hbase.coprocessor.TestOpenTableInCoprocessor
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.075 sec - in org.apache.hadoop.hbase.coprocessor.TestOpenTableInCoprocessor
Running org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithAbort
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 18.816 sec - in org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithAbort
Running org.apache.hadoop.hbase.coprocessor.TestRegionObserverInterface
Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 54.369 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionObserverInterface
Running org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithRemove
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.512 sec - in org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithRemove
Running org.apache.hadoop.hbase.coprocessor.TestAggregateProtocol
Running org.apache.hadoop.hbase.coprocessor.TestBatchCoprocessorEndpoint
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.33 sec - in org.apache.hadoop.hbase.coprocessor.TestBatchCoprocessorEndpoint
Tests run: 44, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.511 sec - in org.apache.hadoop.hbase.coprocessor.TestAggregateProtocol
Running org.apache.hadoop.hbase.coprocessor.TestRegionServerObserver
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 265.212 sec - in org.apache.hadoop.hbase.TestIOFencing
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 481.553 sec - in org.apache.hadoop.hbase.snapshot.TestExportSnapshot
Running org.apache.hadoop.hbase.coprocessor.TestHTableWrapper
Running org.apache.hadoop.hbase.coprocessor.TestRegionServerCoprocessorExceptionWithAbort
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.362 sec - in org.apache.hadoop.hbase.coprocessor.TestHTableWrapper
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 448.171 sec - in org.apache.hadoop.hbase.snapshot.TestSecureExportSnapshot
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 26.142 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionServerObserver
Running org.apache.hadoop.hbase.coprocessor.TestClassLoading
Running org.apache.hadoop.hbase.coprocessor.TestDoubleColumnInterpreter
Running org.apache.hadoop.hbase.coprocessor.TestRegionObserverBypass
Running org.apache.hadoop.hbase.coprocessor.TestRowProcessorEndpoint
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 36.446 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionServerCoprocessorExceptionWithAbort
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.121 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionObserverBypass
Tests run: 38, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 9.982 sec - in org.apache.hadoop.hbase.coprocessor.TestDoubleColumnInterpreter
Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 27.323 sec - in org.apache.hadoop.hbase.coprocessor.TestClassLoading
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 13.334 sec - in org.apache.hadoop.hbase.coprocessor.TestRowProcessorEndpoint
Running org.apache.hadoop.hbase.coprocessor.TestCoprocessorStop
Running org.apache.hadoop.hbase.coprocessor.TestRegionServerCoprocessorExceptionWithRemove
Running org.apache.hadoop.hbase.coprocessor.TestMasterObserver
Running org.apache.hadoop.hbase.coprocessor.TestBigDecimalColumnInterpreter
Running org.apache.hadoop.hbase.coprocessor.TestCoprocessorEndpoint
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.626 sec - in org.apache.hadoop.hbase.coprocessor.TestCoprocessorEndpoint
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 17.148 sec - in org.apache.hadoop.hbase.coprocessor.TestCoprocessorStop
Tests run: 38, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 8.817 sec - in org.apache.hadoop.hbase.coprocessor.TestBigDecimalColumnInterpreter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.254 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionServerCoprocessorExceptionWithRemove
Running org.apache.hadoop.hbase.TestGlobalMemStoreSize
Running org.apache.hadoop.hbase.TestMetaTableLocator
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 21.973 sec - in org.apache.hadoop.hbase.coprocessor.TestMasterObserver
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.808 sec - in org.apache.hadoop.hbase.TestMetaTableLocator
Running org.apache.hadoop.hbase.zookeeper.TestZKMulti
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.143 sec - in org.apache.hadoop.hbase.zookeeper.TestZKMulti
Running org.apache.hadoop.hbase.coprocessor.TestWALObserver
Running org.apache.hadoop.hbase.TestJMXListener
Running org.apache.hadoop.hbase.zookeeper.lock.TestZKInterProcessReadWriteLock
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 30.798 sec - in org.apache.hadoop.hbase.TestGlobalMemStoreSize
Running org.apache.hadoop.hbase.zookeeper.TestZKLeaderManager
Running org.apache.hadoop.hbase.zookeeper.TestZooKeeperACL
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.336 sec - in org.apache.hadoop.hbase.zookeeper.TestZKLeaderManager
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.89 sec - in org.apache.hadoop.hbase.zookeeper.TestZooKeeperACL
Running org.apache.hadoop.hbase.zookeeper.TestRecoverableZooKeeper
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.317 sec - in org.apache.hadoop.hbase.coprocessor.TestWALObserver
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.433 sec - in org.apache.hadoop.hbase.zookeeper.TestRecoverableZooKeeper
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 17.577 sec - in org.apache.hadoop.hbase.TestJMXListener
Running org.apache.hadoop.hbase.zookeeper.TestZooKeeperNodeTracker
Running org.apache.hadoop.hbase.zookeeper.TestHQuorumPeer
Running org.apache.hadoop.hbase.TestClusterBootOrder
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.317 sec - in org.apache.hadoop.hbase.zookeeper.TestZooKeeperNodeTracker
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.291 sec - in org.apache.hadoop.hbase.zookeeper.TestHQuorumPeer
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.641 sec - in org.apache.hadoop.hbase.zookeeper.lock.TestZKInterProcessReadWriteLock
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 32.471 sec - in org.apache.hadoop.hbase.TestClusterBootOrder

Results :

Failed tests: 
  TestRegionPlacement.testRegionPlacement:270->killRandomServerAndVerifyAssignment:347 Region {ENCODED => bbae2403889e76c62d6085d19003bfc0, NAME => 'testRegionAssignment,\x09\x09\x09,1411022811847.bbae2403889e76c62d6085d19003bfc0.', STARTKEY => '\x09\x09\x09', ENDKEY => ''} not present on any of the expected servers
  TestPerTableCFReplication.testPerTableCFReplication:300->ensureRowNotReplicated:386 expected:<0> but was:<1>
  TestZooKeeper.testRegionAssignmentAfterMasterRecoveryDueToZKExpiry:518 expected:<17> but was:<16>

Tests in error: 
  TestRegionPlacement.testFavoredNodesPresentForRoundRobinAssignment:113 ? ArrayIndexOutOfBounds
  TestRegionPlacement.testFavoredNodesPresentForRandomAssignment:173 ? ArrayIndexOutOfBounds
  TestRegionReplicaReplicationEndpoint.testRegionReplicaReplicationForFlushAndCompaction:253->verifyReplication:192 ? 
  TestHFileOutputFormat.testExcludeMinorCompaction:992->runIncrementalPELoad:478 ? IO
  TestReplicaWithCluster.testReplicaAndReplication:302->Object.wait:-2 ?  test t...

Tests run: 1938, Failures: 3, Errors: 5, Skipped: 19

[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO] 
[INFO] HBase ............................................. SUCCESS [4.056s]
[INFO] HBase - Common .................................... SUCCESS [1:31.978s]
[INFO] HBase - Protocol .................................. SUCCESS [13.725s]
[INFO] HBase - Client .................................... SUCCESS [1:14.981s]
[INFO] HBase - Hadoop Compatibility ...................... SUCCESS [9.512s]
[INFO] HBase - Hadoop Two Compatibility .................. SUCCESS [10.164s]
[INFO] HBase - Prefix Tree ............................... SUCCESS [14.469s]
[INFO] HBase - Server .................................... FAILURE [1:56:20.764s]
[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:00:01.007s
[INFO] Finished at: Thu Sep 18 08:03:07 UTC 2014
[INFO] Final Memory: 73M/457M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.17:test (secondPartTestsExecution) on project hbase-server: There was a timeout or other error in the fork -> [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 :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-TRUNK] $ /bin/bash -xe /tmp/hudson7579723645797305917.sh
++ wc -l
++ grep surefirebooter
++ jps
+ ZOMBIE_TESTS_COUNT=1
+ [[ 1 != 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
++ grep surefirebooter
++ wc -l
++ jps
+ 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=
POST BUILD TASK : FAILURE
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1787 artifacts
Archive block size is 32768
Received 73 blocks and 520109679 bytes
Compression is 0.5%
Took 3 min 39 sec
Recording test results
Updating HBASE-11951

Build failed in Jenkins: HBase-TRUNK #5520

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5520/changes>

Changes:

[anoopsamjohn] HBASE-11988 AC/VC system table create on postStartMaster fails too often in test.

[mstanleyjones] HBASE-11730 Document release-managers for non-deprecated branches

[mstanleyjones] HBASE-11761 Add a FAQ item for updating a maven-managed application from 0.94 -> 0.96+

[mstanleyjones] HBASE-11951 Add a script to assist with publishing the website and getting rid of stale files

------------------------------------------
[...truncated 1647 lines...]
java.lang.Exception: test timed out after 30000 milliseconds
	at sun.misc.Unsafe.unpark(Native Method)
	at java.util.concurrent.locks.LockSupport.unpark(LockSupport.java:152)
	at java.util.concurrent.SynchronousQueue$TransferStack$SNode.tryMatch(SynchronousQueue.java:263)
	at java.util.concurrent.SynchronousQueue$TransferStack.transfer(SynchronousQueue.java:380)
	at java.util.concurrent.SynchronousQueue.offer(SynchronousQueue.java:914)
	at java.util.concurrent.ThreadPoolExecutor.execute(ThreadPoolExecutor.java:1364)
	at org.apache.hadoop.hbase.util.BoundedCompletionService.submit(BoundedCompletionService.java:65)
	at org.apache.hadoop.hbase.client.ScannerCallableWithReplicas.addCallsForCurrentReplica(ScannerCallableWithReplicas.java:250)
	at org.apache.hadoop.hbase.client.ScannerCallableWithReplicas.call(ScannerCallableWithReplicas.java:145)
	at org.apache.hadoop.hbase.client.ScannerCallableWithReplicas.call(ScannerCallableWithReplicas.java:56)
	at org.apache.hadoop.hbase.client.RpcRetryingCaller.callWithoutRetries(RpcRetryingCaller.java:179)
	at org.apache.hadoop.hbase.client.ClientScanner.call(ClientScanner.java:287)
	at org.apache.hadoop.hbase.client.ClientScanner.next(ClientScanner.java:367)
	at org.apache.hadoop.hbase.MetaTableAccessor.fullScan(MetaTableAccessor.java:608)
	at org.apache.hadoop.hbase.MetaTableAccessor.tableExists(MetaTableAccessor.java:364)
	at org.apache.hadoop.hbase.client.HBaseAdmin.tableExists(HBaseAdmin.java:274)
	at org.apache.hadoop.hbase.client.HBaseAdmin.checkTableExistence(HBaseAdmin.java:1073)
	at org.apache.hadoop.hbase.client.HBaseAdmin.isTableDisabled(HBaseAdmin.java:1106)
	at org.apache.hadoop.hbase.client.HBaseAdmin.disableTable(HBaseAdmin.java:989)
	at org.apache.hadoop.hbase.client.TestReplicaWithCluster.testReplicaAndReplication(TestReplicaWithCluster.java:299)

Running org.apache.hadoop.hbase.client.TestScannerTimeout
Running org.apache.hadoop.hbase.client.TestReplicasClient
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 43.142 sec - in org.apache.hadoop.hbase.client.TestScannerTimeout
Running org.apache.hadoop.hbase.client.TestTableSnapshotScanner
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 169.193 sec - in org.apache.hadoop.hbase.client.TestRestoreSnapshotFromClientWithRegionReplicas
Tests run: 79, Failures: 0, Errors: 0, Skipped: 4, Time elapsed: 197.249 sec - in org.apache.hadoop.hbase.client.TestFromClientSide
Running org.apache.hadoop.hbase.client.TestFromClientSide3
Running org.apache.hadoop.hbase.client.TestRestoreSnapshotFromClient
Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 111.213 sec - in org.apache.hadoop.hbase.client.TestReplicasClient
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 95.868 sec - in org.apache.hadoop.hbase.client.TestTableSnapshotScanner
Running org.apache.hadoop.hbase.client.TestSnapshotMetadata
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 69.974 sec - in org.apache.hadoop.hbase.client.TestFromClientSide3
Running org.apache.hadoop.hbase.TestMultiVersions
Running org.apache.hadoop.hbase.TestHColumnDescriptorDefaultVersions
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 13.769 sec - in org.apache.hadoop.hbase.TestMultiVersions
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 38.589 sec - in org.apache.hadoop.hbase.client.TestSnapshotMetadata
Running org.apache.hadoop.hbase.procedure.TestZKProcedure
Running org.apache.hadoop.hbase.procedure.TestZKProcedureControllers
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 20.499 sec - in org.apache.hadoop.hbase.TestHColumnDescriptorDefaultVersions
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.776 sec - in org.apache.hadoop.hbase.procedure.TestZKProcedure
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.639 sec - in org.apache.hadoop.hbase.procedure.TestZKProcedureControllers
Running org.apache.hadoop.hbase.constraint.TestConstraint
Running org.apache.hadoop.hbase.TestNamespace
Running org.apache.hadoop.hbase.rest.TestDeleteRow
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 13.646 sec - in org.apache.hadoop.hbase.constraint.TestConstraint
Tests run: 9, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 14.936 sec - in org.apache.hadoop.hbase.TestNamespace
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.058 sec - in org.apache.hadoop.hbase.rest.TestDeleteRow
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 142.222 sec - in org.apache.hadoop.hbase.client.TestRestoreSnapshotFromClient
Running org.apache.hadoop.hbase.rest.TestSchemaResource
Running org.apache.hadoop.hbase.rest.TestScannersWithLabels
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.36 sec - in org.apache.hadoop.hbase.rest.TestScannersWithLabels
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 9.945 sec - in org.apache.hadoop.hbase.rest.TestSchemaResource
Running org.apache.hadoop.hbase.rest.TestTableResource
Running org.apache.hadoop.hbase.rest.TestTableScan
Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.487 sec - in org.apache.hadoop.hbase.rest.TestTableResource
Running org.apache.hadoop.hbase.rest.TestStatusResource
Running org.apache.hadoop.hbase.rest.TestGetAndPutResource
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.817 sec - in org.apache.hadoop.hbase.rest.TestStatusResource
Tests run: 10, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 26.115 sec - in org.apache.hadoop.hbase.rest.TestTableScan
Running org.apache.hadoop.hbase.rest.TestResourceFilter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.855 sec - in org.apache.hadoop.hbase.rest.TestResourceFilter
Running org.apache.hadoop.hbase.rest.client.TestRemoteTable
Tests run: 18, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 47.364 sec - in org.apache.hadoop.hbase.rest.TestGetAndPutResource
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 27.576 sec - in org.apache.hadoop.hbase.rest.client.TestRemoteTable
Running org.apache.hadoop.hbase.rest.TestVersionResource
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.658 sec - in org.apache.hadoop.hbase.rest.TestVersionResource
Running org.apache.hadoop.hbase.rest.TestScannersWithFilters
Running org.apache.hadoop.hbase.rest.TestMultiRowResource
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.188 sec - in org.apache.hadoop.hbase.rest.TestMultiRowResource
Tests run: 10, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 14.24 sec - in org.apache.hadoop.hbase.rest.TestScannersWithFilters
Running org.apache.hadoop.hbase.rest.TestGzipFilter
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.326 sec - in org.apache.hadoop.hbase.rest.TestGzipFilter
Running org.apache.hadoop.hbase.TestZooKeeper
Running org.apache.hadoop.hbase.snapshot.TestFlushSnapshotFromClient
Running org.apache.hadoop.hbase.rest.TestScannerResource
Running org.apache.hadoop.hbase.snapshot.TestExportSnapshot
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 14.162 sec - in org.apache.hadoop.hbase.rest.TestScannerResource
Running org.apache.hadoop.hbase.snapshot.TestSecureExportSnapshot
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 81.21 sec - in org.apache.hadoop.hbase.snapshot.TestFlushSnapshotFromClient
Running org.apache.hadoop.hbase.snapshot.TestRestoreFlushSnapshotFromClient
Tests run: 46, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 583.866 sec - in org.apache.hadoop.hbase.client.TestAdmin
Running org.apache.hadoop.hbase.snapshot.TestSnapshotDescriptionUtils
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.682 sec - in org.apache.hadoop.hbase.snapshot.TestSnapshotDescriptionUtils
Running org.apache.hadoop.hbase.TestIOFencing
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 97.358 sec - in org.apache.hadoop.hbase.snapshot.TestRestoreFlushSnapshotFromClient
Running org.apache.hadoop.hbase.coprocessor.TestRegionObserverScannerOpenHook
Tests run: 11, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 246.472 sec - in org.apache.hadoop.hbase.TestZooKeeper
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 26.242 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionObserverScannerOpenHook
Running org.apache.hadoop.hbase.coprocessor.TestOpenTableInCoprocessor
Running org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithAbort
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.681 sec - in org.apache.hadoop.hbase.coprocessor.TestOpenTableInCoprocessor
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 18.38 sec - in org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithAbort
Running org.apache.hadoop.hbase.coprocessor.TestRegionObserverInterface
Running org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithRemove
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.306 sec - in org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithRemove
Running org.apache.hadoop.hbase.coprocessor.TestAggregateProtocol
Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 54.555 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionObserverInterface
Tests run: 44, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.473 sec - in org.apache.hadoop.hbase.coprocessor.TestAggregateProtocol
Running org.apache.hadoop.hbase.coprocessor.TestBatchCoprocessorEndpoint
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.101 sec - in org.apache.hadoop.hbase.coprocessor.TestBatchCoprocessorEndpoint
Running org.apache.hadoop.hbase.coprocessor.TestHTableWrapper
Running org.apache.hadoop.hbase.coprocessor.TestRegionServerObserver
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.572 sec - in org.apache.hadoop.hbase.coprocessor.TestHTableWrapper
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 284.543 sec - in org.apache.hadoop.hbase.TestIOFencing
Running org.apache.hadoop.hbase.coprocessor.TestRegionServerCoprocessorExceptionWithAbort
Running org.apache.hadoop.hbase.coprocessor.TestClassLoading
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 31.723 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionServerObserver
Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 30.873 sec - in org.apache.hadoop.hbase.coprocessor.TestClassLoading
Running org.apache.hadoop.hbase.coprocessor.TestDoubleColumnInterpreter
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 42.065 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionServerCoprocessorExceptionWithAbort
Tests run: 38, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.165 sec - in org.apache.hadoop.hbase.coprocessor.TestDoubleColumnInterpreter
Running org.apache.hadoop.hbase.coprocessor.TestRegionObserverBypass
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.189 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionObserverBypass
Running org.apache.hadoop.hbase.coprocessor.TestRowProcessorEndpoint
Running org.apache.hadoop.hbase.coprocessor.TestCoprocessorStop
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 483.65 sec - in org.apache.hadoop.hbase.snapshot.TestExportSnapshot
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 14.577 sec - in org.apache.hadoop.hbase.coprocessor.TestRowProcessorEndpoint
Running org.apache.hadoop.hbase.coprocessor.TestRegionServerCoprocessorExceptionWithRemove
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.945 sec - in org.apache.hadoop.hbase.coprocessor.TestCoprocessorStop
Running org.apache.hadoop.hbase.coprocessor.TestBigDecimalColumnInterpreter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.581 sec - in org.apache.hadoop.hbase.coprocessor.TestRegionServerCoprocessorExceptionWithRemove
Running org.apache.hadoop.hbase.coprocessor.TestMasterObserver
Tests run: 38, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.126 sec - in org.apache.hadoop.hbase.coprocessor.TestBigDecimalColumnInterpreter
Running org.apache.hadoop.hbase.TestGlobalMemStoreSize
Running org.apache.hadoop.hbase.coprocessor.TestCoprocessorEndpoint
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.498 sec - in org.apache.hadoop.hbase.coprocessor.TestCoprocessorEndpoint
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 20.273 sec - in org.apache.hadoop.hbase.coprocessor.TestMasterObserver
Running org.apache.hadoop.hbase.coprocessor.TestWALObserver
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 489.454 sec - in org.apache.hadoop.hbase.snapshot.TestSecureExportSnapshot
Running org.apache.hadoop.hbase.TestMetaTableLocator
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.335 sec - in org.apache.hadoop.hbase.TestMetaTableLocator
Running org.apache.hadoop.hbase.zookeeper.TestZKMulti
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.595 sec - in org.apache.hadoop.hbase.coprocessor.TestWALObserver
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.268 sec - in org.apache.hadoop.hbase.zookeeper.TestZKMulti
Running org.apache.hadoop.hbase.TestJMXListener
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 32.978 sec - in org.apache.hadoop.hbase.TestGlobalMemStoreSize
Running org.apache.hadoop.hbase.zookeeper.lock.TestZKInterProcessReadWriteLock
Running org.apache.hadoop.hbase.zookeeper.TestZKLeaderManager
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.335 sec - in org.apache.hadoop.hbase.zookeeper.TestZKLeaderManager
Running org.apache.hadoop.hbase.zookeeper.TestRecoverableZooKeeper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.628 sec - in org.apache.hadoop.hbase.zookeeper.TestRecoverableZooKeeper
Running org.apache.hadoop.hbase.zookeeper.TestZooKeeperNodeTracker
Running org.apache.hadoop.hbase.zookeeper.TestZooKeeperACL
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.822 sec - in org.apache.hadoop.hbase.zookeeper.TestZooKeeperACL
Running org.apache.hadoop.hbase.zookeeper.TestHQuorumPeer
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.377 sec - in org.apache.hadoop.hbase.zookeeper.TestZooKeeperNodeTracker
Running org.apache.hadoop.hbase.TestClusterBootOrder
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.017 sec - in org.apache.hadoop.hbase.zookeeper.TestHQuorumPeer
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.918 sec - in org.apache.hadoop.hbase.TestJMXListener
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.449 sec - in org.apache.hadoop.hbase.zookeeper.lock.TestZKInterProcessReadWriteLock
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 34.293 sec - in org.apache.hadoop.hbase.TestClusterBootOrder

Results :

Failed tests: 
  TestSplitLogManager.testGetPreviousRecoveryMode:651 null
  TestPerTableCFReplication.testPerTableCFReplication:300->ensureRowNotReplicated:386 expected:<0> but was:<1>

Tests in error: 
  TestEndToEndSplitTransaction.blockUntilRegionSplit:451->blockUntilRegionIsInMeta:474 NullPointer
  TestReplicaWithCluster.testReplicaAndReplication:299 ?  test timed out after 3...

Tests run: 1982, Failures: 2, Errors: 2, Skipped: 19

[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO] 
[INFO] HBase ............................................. SUCCESS [3.904s]
[INFO] HBase - Common .................................... SUCCESS [1:31.796s]
[INFO] HBase - Protocol .................................. SUCCESS [14.484s]
[INFO] HBase - Client .................................... SUCCESS [1:14.939s]
[INFO] HBase - Hadoop Compatibility ...................... SUCCESS [9.344s]
[INFO] HBase - Hadoop Two Compatibility .................. SUCCESS [10.080s]
[INFO] HBase - Prefix Tree ............................... SUCCESS [14.835s]
[INFO] HBase - Server .................................... FAILURE [1:57:24.946s]
[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:01:05.737s
[INFO] Finished at: Thu Sep 18 05:04:08 UTC 2014
[INFO] Final Memory: 40M/623M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.17:test (secondPartTestsExecution) on project hbase-server: There was a timeout or other error in the fork -> [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 :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-TRUNK] $ /bin/bash -xe /tmp/hudson3325036631058633549.sh
++ jps
++ grep surefirebooter
++ wc -l
+ ZOMBIE_TESTS_COUNT=0
+ [[ 0 != 0 ]]
+ echo 'We'\''re ok: there is no zombie test'
We're ok: there is no zombie test
POST BUILD TASK : SUCCESS
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1787 artifacts
Archive block size is 32768
Received 73 blocks and 502643523 bytes
Compression is 0.5%
Took 3 min 35 sec
Recording test results
Updating HBASE-11761
Updating HBASE-11951
Updating HBASE-11730
Updating HBASE-11988

Build failed in Jenkins: HBase-TRUNK #5519

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5519/changes>

Changes:

[jmhsieh] HBASE-11405 Multiple invocations of hbck in parallel disables balancer permanently (Bharath Vissapragada)

[jmhsieh] Revert "HBASE-11405 Multiple invocations of hbck in parallel disables balancer permanently (Bharath Vissapragada)"

------------------------------------------
[...truncated 12854 lines...]
   java.lang.Thread.State: TIMED_WAITING (parking)
	at sun.misc.Unsafe.park(Native Method)
	- parking to wait for  <0x80dc3878> (a java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject)
	at java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:226)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.awaitNanos(AbstractQueuedSynchronizer.java:2082)
	at java.util.concurrent.LinkedBlockingQueue.poll(LinkedBlockingQueue.java:467)
	at org.apache.hadoop.ipc.CallQueueManager.take(CallQueueManager.java:109)
	at org.apache.hadoop.ipc.Server$Handler.run(Server.java:1985)

"IPC Server listener on 41220" daemon prio=10 tid=0x60b4a400 nid=0x2ecc runnable [0x6050b000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x80dced30> (a sun.nio.ch.Util$2)
	- locked <0x80dced20> (a java.util.Collections$UnmodifiableSet)
	- locked <0x80dce918> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener.run(Server.java:668)

"IPC Server Responder" daemon prio=10 tid=0x60b49800 nid=0x2ecb runnable [0x61eac000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x80dd0728> (a sun.nio.ch.Util$2)
	- locked <0x80dd0718> (a java.util.Collections$UnmodifiableSet)
	- locked <0x80dd0518> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.apache.hadoop.ipc.Server$Responder.doRunLoop(Server.java:835)
	at org.apache.hadoop.ipc.Server$Responder.run(Server.java:818)

"org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor@65168f" daemon prio=10 tid=0x60b40800 nid=0x2ebf waiting on condition [0x6055c000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor.run(BlockManager.java:3336)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor@ac1d0e" daemon prio=10 tid=0x60b3f400 nid=0x2ebe waiting on condition [0x605ad000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor.run(HeartbeatManager.java:307)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor@b0d204" daemon prio=10 tid=0x60b3e800 nid=0x2ebd waiting on condition [0x605fe000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor.run(DecommissionManager.java:76)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor@154a2b2" daemon prio=10 tid=0x60b3d400 nid=0x2ebc waiting on condition [0x61e5b000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor.run(PendingReplicationBlocks.java:221)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.util.JvmPauseMonitor$Monitor@11c640f" daemon prio=10 tid=0x60b38800 nid=0x2eb5 waiting on condition [0x61efd000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.util.JvmPauseMonitor$Monitor.run(JvmPauseMonitor.java:161)
	at java.lang.Thread.run(Thread.java:724)

"IPC Server idle connection scanner for port 41220" daemon prio=10 tid=0x60b05c00 nid=0x2eb2 in Object.wait() [0x6335c000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x80dce2a0> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Socket Reader #1 for port 41220" prio=10 tid=0x60b06800 nid=0x2eb1 runnable [0x633ad000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x80dcd338> (a sun.nio.ch.Util$2)
	- locked <0x80dcd328> (a java.util.Collections$UnmodifiableSet)
	- locked <0x80dcd098> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener$Reader.doRunLoop(Server.java:616)
	- locked <0x80dcef00> (a org.apache.hadoop.ipc.Server$Listener$Reader)
	at org.apache.hadoop.ipc.Server$Listener$Reader.run(Server.java:595)

"Timer-0" daemon prio=10 tid=0x60d2bc00 nid=0x2e04 in Object.wait() [0x633fe000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7fd7d128> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"524158@qtp-31611972-1 - Acceptor0 SelectChannelConnector@localhost:35067" daemon prio=10 tid=0x60d10800 nid=0x2dd8 runnable [0x6427d000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x800054b8> (a sun.nio.ch.Util$2)
	- locked <0x800054c8> (a java.util.Collections$UnmodifiableSet)
	- locked <0x80005478> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.mortbay.io.nio.SelectorManager$SelectSet.doSelect(SelectorManager.java:498)
	at org.mortbay.io.nio.SelectorManager.doSelect(SelectorManager.java:192)
	at org.mortbay.jetty.nio.SelectChannelConnector.accept(SelectChannelConnector.java:124)
	at org.mortbay.jetty.AbstractConnector$Acceptor.run(AbstractConnector.java:708)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:582)

"15885819@qtp-31611972-0" daemon prio=10 tid=0x60d12000 nid=0x2dd7 in Object.wait() [0x64e52000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:626)
	- locked <0x800058d0> (a org.mortbay.thread.QueuedThreadPool$PoolThread)

"Timer for 'NameNode' metrics system" daemon prio=10 tid=0x625bd400 nid=0x2db8 in Object.wait() [0x6447d000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7fd65068> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Service Thread" daemon prio=10 tid=0x64cf7000 nid=0x2a90 runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread1" daemon prio=10 tid=0x64cf5400 nid=0x2a8f waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread0" daemon prio=10 tid=0x64cf3400 nid=0x2a8e waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Signal Dispatcher" daemon prio=10 tid=0x64cf1800 nid=0x2a8b runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Finalizer" daemon prio=10 tid=0x64cb7000 nid=0x2a53 in Object.wait() [0x6bc7d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	- waiting on <0x7cc21da0> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:135)
	- locked <0x7cc21da0> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:151)
	at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:189)

"Reference Handler" daemon prio=10 tid=0x64cb5400 nid=0x2a52 in Object.wait() [0x6be7d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.Object.wait(Object.java:503)
	at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:133)
	- locked <0x7cc23f78> (a java.lang.ref.Reference$Lock)

"main" prio=10 tid=0xf6706800 nid=0x2a32 sleeping[0xf6883000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hbase.security.visibility.TestVisibilityLabels.testVisibilityLabelsOnKillingOfRSContainingLabelsTable(TestVisibilityLabels.java:359)
	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.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:47)
	at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:12)
	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:44)
	at org.junit.internal.runners.statements.InvokeMethod.evaluate(InvokeMethod.java:17)
	at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:27)
	at org.junit.rules.TestWatcher$1.evaluate(TestWatcher.java:55)
	at org.junit.rules.RunRules.evaluate(RunRules.java:20)
	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:271)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:70)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:26)
	at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:27)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runners.Suite.runChild(Suite.java:127)
	at org.junit.runners.Suite.runChild(Suite.java:26)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:160)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:138)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.createRequestAndRun(JUnitCoreWrapper.java:113)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.executeEager(JUnitCoreWrapper.java:85)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.execute(JUnitCoreWrapper.java:54)
	at org.apache.maven.surefire.junitcore.JUnitCoreProvider.invoke(JUnitCoreProvider.java:134)
	at org.apache.maven.surefire.booter.ForkedBooter.invokeProviderInSameClassLoader(ForkedBooter.java:200)
	at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:153)
	at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:103)

"VM Thread" prio=10 tid=0x64bf8800 nid=0x2a50 runnable 

"GC task thread#0 (ParallelGC)" prio=10 tid=0xf6710800 nid=0x2a34 runnable 

"GC task thread#1 (ParallelGC)" prio=10 tid=0xf6712000 nid=0x2a35 runnable 

"GC task thread#2 (ParallelGC)" prio=10 tid=0xf6713800 nid=0x2a37 runnable 

"GC task thread#3 (ParallelGC)" prio=10 tid=0xf6715000 nid=0x2a38 runnable 

"GC task thread#4 (ParallelGC)" prio=10 tid=0xf6716400 nid=0x2a39 runnable 

"GC task thread#5 (ParallelGC)" prio=10 tid=0xf6717c00 nid=0x2a3a runnable 

"GC task thread#6 (ParallelGC)" prio=10 tid=0xf6719400 nid=0x2a3b runnable 

"GC task thread#7 (ParallelGC)" prio=10 tid=0xf671a800 nid=0x2a3c runnable 

"GC task thread#8 (ParallelGC)" prio=10 tid=0xf671c000 nid=0x2a3d runnable 

"GC task thread#9 (ParallelGC)" prio=10 tid=0xf671d800 nid=0x2a3e runnable 

"GC task thread#10 (ParallelGC)" prio=10 tid=0xf671ec00 nid=0x2a3f runnable 

"GC task thread#11 (ParallelGC)" prio=10 tid=0xf6720400 nid=0x2a40 runnable 

"GC task thread#12 (ParallelGC)" prio=10 tid=0xf6721c00 nid=0x2a41 runnable 

"VM Periodic Task Thread" prio=10 tid=0x64cf8c00 nid=0x2a91 waiting on condition 

JNI global references: 171

+ echo '************ END  zombies jstack extract'
************ END  zombies jstack extract
+ JIRA_COMMENT='

     {color:red}-1 core zombie tests{color}.  There are 2 zombie test(s): 	at org.apache.hadoop.hbase.security.visibility.TestVisibilityLabels.testVisibilityLabelsOnRSRestart(TestVisibilityLabels.java:406)
	at org.apache.hadoop.hbase.security.visibility.TestVisibilityLabels.testVisibilityLabelsOnKillingOfRSContainingLabelsTable(TestVisibilityLabels.java:359)'
+ BAD=1
+ jps
+ grep surefirebooter
+ cut -d ' ' -f 1
+ xargs kill -9
POST BUILD TASK : SUCCESS
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1782 artifacts
Archive block size is 32768
Received 73 blocks and 594892070 bytes
Compression is 0.4%
Took 4 min 9 sec
Recording test results
Updating HBASE-11405

Build failed in Jenkins: HBase-TRUNK #5518

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5518/changes>

Changes:

[jxiang] HBASE-11991 Region states may be out of sync

------------------------------------------
[...truncated 1614 lines...]
Running org.apache.hadoop.hbase.client.TestPutWithDelete
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.48 sec - in org.apache.hadoop.hbase.client.TestPutWithDelete
Running org.apache.hadoop.hbase.TestLocalHBaseCluster
Running org.apache.hadoop.hbase.client.TestHCM
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 9.968 sec - in org.apache.hadoop.hbase.TestLocalHBaseCluster
Running org.apache.hadoop.hbase.snapshot.TestSnapshotDescriptionUtils
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.206 sec - in org.apache.hadoop.hbase.snapshot.TestSnapshotDescriptionUtils
Running org.apache.hadoop.hbase.snapshot.TestFlushSnapshotFromClient
Tests run: 79, Failures: 0, Errors: 0, Skipped: 4, Time elapsed: 121.88 sec - in org.apache.hadoop.hbase.client.TestFromClientSide
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 67.233 sec - in org.apache.hadoop.hbase.client.TestCloneSnapshotFromClient
Running org.apache.hadoop.hbase.snapshot.TestRestoreFlushSnapshotFromClient
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 46.271 sec - in org.apache.hadoop.hbase.snapshot.TestFlushSnapshotFromClient
Running org.apache.hadoop.hbase.snapshot.TestExportSnapshot
Running org.apache.hadoop.hbase.snapshot.TestSecureExportSnapshot
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 58.213 sec - in org.apache.hadoop.hbase.snapshot.TestRestoreFlushSnapshotFromClient
Running org.apache.hadoop.hbase.TestMultiVersions
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.465 sec - in org.apache.hadoop.hbase.TestMultiVersions
Running org.apache.hadoop.hbase.TestGlobalMemStoreSize
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 18.53 sec - in org.apache.hadoop.hbase.TestGlobalMemStoreSize
Running org.apache.hadoop.hbase.TestRegionRebalancing
Tests run: 21, Failures: 0, Errors: 0, Skipped: 2, Time elapsed: 165.774 sec - in org.apache.hadoop.hbase.client.TestHCM
Running org.apache.hadoop.hbase.security.access.TestScanEarlyTermination
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.065 sec - in org.apache.hadoop.hbase.security.access.TestScanEarlyTermination
Running org.apache.hadoop.hbase.security.access.TestZKPermissionsWatcher
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.043 sec - in org.apache.hadoop.hbase.security.access.TestZKPermissionsWatcher
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 43.079 sec - in org.apache.hadoop.hbase.TestRegionRebalancing
Tests run: 1, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: -2,059,758.987 sec <<< FAILURE! - in org.apache.hadoop.hbase.security.access.TestAccessControlFilter
org.apache.hadoop.hbase.security.access.TestAccessControlFilter  Time elapsed: -2,059,758.988 sec  <<< FAILURE!
java.lang.AssertionError: Timed out waiting for table to become available and enabled hbase:acl
	at org.junit.Assert.fail(Assert.java:88)
	at org.junit.Assert.assertTrue(Assert.java:41)
	at org.apache.hadoop.hbase.HBaseTestingUtility.waitTableEnabled(HBaseTestingUtility.java:2803)
	at org.apache.hadoop.hbase.HBaseTestingUtility.waitTableEnabled(HBaseTestingUtility.java:2793)
	at org.apache.hadoop.hbase.security.access.TestAccessControlFilter.setupBeforeClass(TestAccessControlFilter.java:81)

Running org.apache.hadoop.hbase.security.access.TestCellACLs
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 8.512 sec - in org.apache.hadoop.hbase.security.access.TestCellACLs
Running org.apache.hadoop.hbase.security.access.TestTablePermissions
Running org.apache.hadoop.hbase.security.access.TestCellACLWithMultipleVersions
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 14.178 sec - in org.apache.hadoop.hbase.security.access.TestTablePermissions
Running org.apache.hadoop.hbase.security.access.TestNamespaceCommands
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.701 sec - in org.apache.hadoop.hbase.security.access.TestNamespaceCommands
Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 23.518 sec - in org.apache.hadoop.hbase.security.access.TestCellACLWithMultipleVersions
Running org.apache.hadoop.hbase.security.access.TestAccessController
Running org.apache.hadoop.hbase.security.access.TestAccessController2
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.207 sec - in org.apache.hadoop.hbase.security.access.TestAccessController2
Running org.apache.hadoop.hbase.security.token.TestZKSecretWatcher
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 13.386 sec - in org.apache.hadoop.hbase.security.token.TestZKSecretWatcher
Running org.apache.hadoop.hbase.security.token.TestTokenAuthentication
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.667 sec - in org.apache.hadoop.hbase.security.token.TestTokenAuthentication
Running org.apache.hadoop.hbase.security.visibility.TestEnforcingScanLabelGenerator
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.043 sec - in org.apache.hadoop.hbase.security.visibility.TestEnforcingScanLabelGenerator
Tests run: 46, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 525.236 sec - in org.apache.hadoop.hbase.client.TestAdmin
Running org.apache.hadoop.hbase.security.visibility.TestVisibilityWithCheckAuths
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.322 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityWithCheckAuths
Tests run: 1, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: -2,059,634.21 sec <<< FAILURE! - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithSLGStack
org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithSLGStack  Time elapsed: -2,059,634.211 sec  <<< FAILURE!
java.lang.AssertionError: Timed out waiting for table to become available and enabled hbase:labels
	at org.junit.Assert.fail(Assert.java:88)
	at org.junit.Assert.assertTrue(Assert.java:41)
	at org.apache.hadoop.hbase.HBaseTestingUtility.waitTableEnabled(HBaseTestingUtility.java:2803)
	at org.apache.hadoop.hbase.HBaseTestingUtility.waitTableEnabled(HBaseTestingUtility.java:2793)
	at org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithSLGStack.setupBeforeClass(TestVisibilityLabelsWithSLGStack.java:78)

Running org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithACL
Running org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsOpWithDifferentUsersNoACL
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.195 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsOpWithDifferentUsersNoACL
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.46 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithACL
Running org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithDistributedLogReplay
Running org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithDefaultVisLabelService
Tests run: 21, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 20.958 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithDistributedLogReplay
Tests run: 21, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 19.545 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithDefaultVisLabelService
Tests run: 46, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 126.319 sec - in org.apache.hadoop.hbase.security.access.TestAccessController
Running org.apache.hadoop.hbase.fs.TestBlockReorder
Running org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithDeletes
Running org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithCustomVisLabService
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 349.685 sec - in org.apache.hadoop.hbase.snapshot.TestExportSnapshot
Tests run: 19, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.025 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithCustomVisLabService
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 29.773 sec - in org.apache.hadoop.hbase.fs.TestBlockReorder
Running org.apache.hadoop.hbase.TestInfoServers
Running org.apache.hadoop.hbase.backup.example.TestZooKeeperTableArchiveClient
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.6 sec - in org.apache.hadoop.hbase.TestInfoServers
Running org.apache.hadoop.hbase.zookeeper.TestHQuorumPeer
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.083 sec - in org.apache.hadoop.hbase.backup.example.TestZooKeeperTableArchiveClient
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.766 sec - in org.apache.hadoop.hbase.zookeeper.TestHQuorumPeer
Running org.apache.hadoop.hbase.zookeeper.lock.TestZKInterProcessReadWriteLock
Running org.apache.hadoop.hbase.backup.TestHFileArchiving
Running org.apache.hadoop.hbase.zookeeper.TestRecoverableZooKeeper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.297 sec - in org.apache.hadoop.hbase.zookeeper.TestRecoverableZooKeeper
Running org.apache.hadoop.hbase.zookeeper.TestZKLeaderManager
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.16 sec - in org.apache.hadoop.hbase.zookeeper.TestZKLeaderManager
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 358.721 sec - in org.apache.hadoop.hbase.snapshot.TestSecureExportSnapshot
Running org.apache.hadoop.hbase.zookeeper.TestZooKeeperNodeTracker
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.969 sec - in org.apache.hadoop.hbase.zookeeper.TestZooKeeperNodeTracker
Running org.apache.hadoop.hbase.zookeeper.TestZKMulti
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.554 sec - in org.apache.hadoop.hbase.zookeeper.TestZKMulti
Running org.apache.hadoop.hbase.zookeeper.TestZooKeeperACL
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.453 sec - in org.apache.hadoop.hbase.zookeeper.TestZooKeeperACL
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.014 sec - in org.apache.hadoop.hbase.zookeeper.lock.TestZKInterProcessReadWriteLock
Tests run: 37, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 57.603 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithDeletes
Running org.apache.hadoop.hbase.mapreduce.TestHLogRecordReader
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.539 sec - in org.apache.hadoop.hbase.mapreduce.TestHLogRecordReader
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 49.383 sec - in org.apache.hadoop.hbase.backup.TestHFileArchiving
Running org.apache.hadoop.hbase.mapreduce.TestTableInputFormatScan2
Running org.apache.hadoop.hbase.mapreduce.TestImportExport
Running org.apache.hadoop.hbase.mapreduce.TestTableMapReduce
Running org.apache.hadoop.hbase.mapreduce.TestWALPlayer
Running org.apache.hadoop.hbase.mapreduce.TestCopyTable
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 70.714 sec - in org.apache.hadoop.hbase.mapreduce.TestWALPlayer
Running org.apache.hadoop.hbase.mapreduce.TestImportTSVWithOperationAttributes
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 201.048 sec - in org.apache.hadoop.hbase.mapreduce.TestTableMapReduce
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 185.377 sec - in org.apache.hadoop.hbase.mapreduce.TestCopyTable
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 95.369 sec - in org.apache.hadoop.hbase.mapreduce.TestImportTSVWithOperationAttributes
Running org.apache.hadoop.hbase.mapreduce.TestSecureLoadIncrementalHFiles
Running org.apache.hadoop.hbase.mapreduce.TestRowCounter
Running org.apache.hadoop.hbase.mapreduce.TestImportTsv
Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 51.377 sec - in org.apache.hadoop.hbase.mapreduce.TestSecureLoadIncrementalHFiles
Running org.apache.hadoop.hbase.mapreduce.TestTimeRangeMapRed
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 315.666 sec - in org.apache.hadoop.hbase.mapreduce.TestTableInputFormatScan2
Running org.apache.hadoop.hbase.mapreduce.TestTableSnapshotInputFormat
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 132.478 sec - in org.apache.hadoop.hbase.mapreduce.TestRowCounter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 78.555 sec - in org.apache.hadoop.hbase.mapreduce.TestTimeRangeMapRed
Running org.apache.hadoop.hbase.mapreduce.TestLoadIncrementalHFiles
Running org.apache.hadoop.hbase.mapreduce.TestHRegionPartitioner
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.639 sec - in org.apache.hadoop.hbase.mapreduce.TestHRegionPartitioner
Running org.apache.hadoop.hbase.mapreduce.TestLoadIncrementalHFilesSplitRecovery
Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 49.273 sec - in org.apache.hadoop.hbase.mapreduce.TestLoadIncrementalHFiles
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 22.628 sec - in org.apache.hadoop.hbase.mapreduce.TestLoadIncrementalHFilesSplitRecovery
Running org.apache.hadoop.hbase.mapreduce.TestHFileOutputFormat
Running org.apache.hadoop.hbase.mapreduce.TestImportTSVWithVisibilityLabels
Tests run: 11, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 489.734 sec - in org.apache.hadoop.hbase.mapreduce.TestImportExport
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 256.495 sec - in org.apache.hadoop.hbase.mapreduce.TestImportTsv
Running org.apache.hadoop.hbase.mapreduce.TestHFileOutputFormat2
Running org.apache.hadoop.hbase.mapreduce.TestMultithreadedTableMapper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 110.936 sec - in org.apache.hadoop.hbase.mapreduce.TestMultithreadedTableMapper
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 359.779 sec - in org.apache.hadoop.hbase.mapreduce.TestTableSnapshotInputFormat
Running org.apache.hadoop.hbase.mapreduce.TestTableInputFormatScan1
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 223.367 sec - in org.apache.hadoop.hbase.mapreduce.TestImportTSVWithVisibilityLabels
Running org.apache.hadoop.hbase.mapreduce.TestCellCounter
Running org.apache.hadoop.hbase.mapreduce.TestMultiTableInputFormat
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 67.742 sec - in org.apache.hadoop.hbase.mapreduce.TestCellCounter
Tests run: 13, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 339.209 sec - in org.apache.hadoop.hbase.mapreduce.TestHFileOutputFormat
Running org.apache.hadoop.hbase.mapreduce.TestSecureLoadIncrementalHFilesSplitRecovery
Running org.apache.hadoop.hbase.filter.TestFilterWithScanLimits
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.638 sec - in org.apache.hadoop.hbase.filter.TestFilterWithScanLimits
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 22.822 sec - in org.apache.hadoop.hbase.mapreduce.TestSecureLoadIncrementalHFilesSplitRecovery
Tests run: 13, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 336.889 sec - in org.apache.hadoop.hbase.mapreduce.TestHFileOutputFormat2
Running org.apache.hadoop.hbase.filter.TestFuzzyRowAndColumnRangeFilter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.386 sec - in org.apache.hadoop.hbase.filter.TestFuzzyRowAndColumnRangeFilter
Running org.apache.hadoop.hbase.filter.TestColumnRangeFilter
Running org.apache.hadoop.hbase.filter.TestFilterWrapper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.152 sec - in org.apache.hadoop.hbase.filter.TestFilterWrapper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.417 sec - in org.apache.hadoop.hbase.filter.TestColumnRangeFilter
Running org.apache.hadoop.hbase.TestMetaTableAccessor
Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 13.352 sec - in org.apache.hadoop.hbase.TestMetaTableAccessor
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 193.602 sec - in org.apache.hadoop.hbase.mapreduce.TestMultiTableInputFormat
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 267.69 sec - in org.apache.hadoop.hbase.mapreduce.TestTableInputFormatScan1

Results :

Failed tests: 
  TestAccessControlFilter.setupBeforeClass:81 Timed out waiting for table to become available and enabled hbase:acl
  TestVisibilityLabelsWithSLGStack.setupBeforeClass:78 Timed out waiting for table to become available and enabled hbase:labels

Tests run: 2007, Failures: 2, Errors: 0, Skipped: 19

[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO] 
[INFO] HBase ............................................. SUCCESS [3.695s]
[INFO] HBase - Common .................................... SUCCESS [1:17.156s]
[INFO] HBase - Protocol .................................. SUCCESS [12.848s]
[INFO] HBase - Client .................................... SUCCESS [1:08.327s]
[INFO] HBase - Hadoop Compatibility ...................... SUCCESS [7.595s]
[INFO] HBase - Hadoop Two Compatibility .................. SUCCESS [7.223s]
[INFO] HBase - Prefix Tree ............................... SUCCESS [10.564s]
[INFO] HBase - Server .................................... FAILURE [1:19:19.379s]
[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: 1:22:27.834s
[INFO] Finished at: Wed Sep 17 20:28:41 UTC 2014
[INFO] Final Memory: 40M/477M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.17:test (secondPartTestsExecution) on project hbase-server: There are test failures.
[ERROR] 
[ERROR] Please refer to <https://builds.apache.org/job/HBase-TRUNK/ws/hbase-server/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 :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-TRUNK] $ /bin/bash -xe /tmp/hudson5571647790190345807.sh
++ jps
++ grep surefirebooter
++ wc -l
+ ZOMBIE_TESTS_COUNT=0
+ [[ 0 != 0 ]]
+ echo 'We'\''re ok: there is no zombie test'
We're ok: there is no zombie test
POST BUILD TASK : SUCCESS
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1789 artifacts
Archive block size is 32768
Received 73 blocks and 533451754 bytes
Compression is 0.4%
Took 2 min 44 sec
Recording test results
Updating HBASE-11991

Build failed in Jenkins: HBase-TRUNK #5517

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5517/>

------------------------------------------
[...truncated 7400 lines...]
	- parking to wait for  <0x815d61d0> (a java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject)
	at java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:226)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.awaitNanos(AbstractQueuedSynchronizer.java:2082)
	at java.util.concurrent.LinkedBlockingQueue.poll(LinkedBlockingQueue.java:467)
	at org.apache.hadoop.ipc.CallQueueManager.take(CallQueueManager.java:109)
	at org.apache.hadoop.ipc.Server$Handler.run(Server.java:1985)

"IPC Server handler 0 on 45622" daemon prio=10 tid=0x63e11400 nid=0x16dc waiting on condition [0x61bfe000]
   java.lang.Thread.State: TIMED_WAITING (parking)
	at sun.misc.Unsafe.park(Native Method)
	- parking to wait for  <0x815d61d0> (a java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject)
	at java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:226)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.awaitNanos(AbstractQueuedSynchronizer.java:2082)
	at java.util.concurrent.LinkedBlockingQueue.poll(LinkedBlockingQueue.java:467)
	at org.apache.hadoop.ipc.CallQueueManager.take(CallQueueManager.java:109)
	at org.apache.hadoop.ipc.Server$Handler.run(Server.java:1985)

"IPC Server listener on 45622" daemon prio=10 tid=0x63e10400 nid=0x16db runnable [0x6275c000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x81fc6140> (a sun.nio.ch.Util$2)
	- locked <0x81fc6150> (a java.util.Collections$UnmodifiableSet)
	- locked <0x81fc6100> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener.run(Server.java:668)

"IPC Server Responder" daemon prio=10 tid=0x63e0f800 nid=0x16da runnable [0x629fe000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x81fc6c10> (a sun.nio.ch.Util$2)
	- locked <0x81fc6c20> (a java.util.Collections$UnmodifiableSet)
	- locked <0x81fc6bd0> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.apache.hadoop.ipc.Server$Responder.doRunLoop(Server.java:835)
	at org.apache.hadoop.ipc.Server$Responder.run(Server.java:818)

"org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor@aaadcc" daemon prio=10 tid=0x61c38000 nid=0x16c6 waiting on condition [0x627ad000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor.run(BlockManager.java:3336)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor@17867ea" daemon prio=10 tid=0x61c36c00 nid=0x16c5 waiting on condition [0x627fe000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor.run(HeartbeatManager.java:307)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor@1d01ab1" daemon prio=10 tid=0x61c36000 nid=0x16c4 waiting on condition [0x6295c000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor.run(DecommissionManager.java:76)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor@1272ac3" daemon prio=10 tid=0x61c34c00 nid=0x16c3 waiting on condition [0x629ad000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor.run(PendingReplicationBlocks.java:221)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.util.JvmPauseMonitor$Monitor@14411c" daemon prio=10 tid=0x61c2e000 nid=0x16b7 waiting on condition [0x62f5c000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.util.JvmPauseMonitor$Monitor.run(JvmPauseMonitor.java:161)
	at java.lang.Thread.run(Thread.java:724)

"IPC Server idle connection scanner for port 45622" daemon prio=10 tid=0x60bf5400 nid=0x169e in Object.wait() [0x62fad000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x81fc8158> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Socket Reader #1 for port 45622" prio=10 tid=0x60bf4000 nid=0x169d runnable [0x62ffe000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x81fc84d0> (a sun.nio.ch.Util$2)
	- locked <0x81fc84e0> (a java.util.Collections$UnmodifiableSet)
	- locked <0x815c3870> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener$Reader.doRunLoop(Server.java:616)
	- locked <0x81fc6708> (a org.apache.hadoop.ipc.Server$Listener$Reader)
	at org.apache.hadoop.ipc.Server$Listener$Reader.run(Server.java:595)

"Timer-0" daemon prio=10 tid=0x63e30000 nid=0x14a5 in Object.wait() [0x6427d000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7fdb2118> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"3616494@qtp-9116170-1 - Acceptor0 SelectChannelConnector@localhost:56592" daemon prio=10 tid=0x63252c00 nid=0x1447 runnable [0x6447d000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x7fda6dc8> (a sun.nio.ch.Util$2)
	- locked <0x7fda6db8> (a java.util.Collections$UnmodifiableSet)
	- locked <0x7fda69b8> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.mortbay.io.nio.SelectorManager$SelectSet.doSelect(SelectorManager.java:498)
	at org.mortbay.io.nio.SelectorManager.doSelect(SelectorManager.java:192)
	at org.mortbay.jetty.nio.SelectChannelConnector.accept(SelectChannelConnector.java:124)
	at org.mortbay.jetty.AbstractConnector$Acceptor.run(AbstractConnector.java:708)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:582)

"20498926@qtp-9116170-0" daemon prio=10 tid=0x63251000 nid=0x1444 in Object.wait() [0x6aa6c000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:626)
	- locked <0x7fda7110> (a org.mortbay.thread.QueuedThreadPool$PoolThread)

"Timer for 'NameNode' metrics system" daemon prio=10 tid=0x62653c00 nid=0x13dd in Object.wait() [0x64660000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7fda7860> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Service Thread" daemon prio=10 tid=0x64cf7000 nid=0xdd7 runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread1" daemon prio=10 tid=0x64cf5400 nid=0xdd6 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread0" daemon prio=10 tid=0x64cf3400 nid=0xdd5 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Signal Dispatcher" daemon prio=10 tid=0x64cf1800 nid=0xdd4 runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Finalizer" daemon prio=10 tid=0x64cb7000 nid=0xdce in Object.wait() [0x6be7d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:135)
	- locked <0x7cbdf058> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:151)
	at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:189)

"Reference Handler" daemon prio=10 tid=0x64cb5400 nid=0xdcd in Object.wait() [0x6c07d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.Object.wait(Object.java:503)
	at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:133)
	- locked <0x7cbdeba0> (a java.lang.ref.Reference$Lock)

"main" prio=10 tid=0xf6706800 nid=0xdba in Object.wait() [0xf68c8000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.Thread.join(Thread.java:1268)
	- locked <0xe9851510> (a org.junit.internal.runners.statements.FailOnTimeout$StatementThread)
	at org.junit.internal.runners.statements.FailOnTimeout.evaluateStatement(FailOnTimeout.java:26)
	at org.junit.internal.runners.statements.FailOnTimeout.evaluate(FailOnTimeout.java:17)
	at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:26)
	at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:27)
	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:271)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:70)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:26)
	at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:27)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runners.Suite.runChild(Suite.java:127)
	at org.junit.runners.Suite.runChild(Suite.java:26)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:160)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:138)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.createRequestAndRun(JUnitCoreWrapper.java:113)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.executeEager(JUnitCoreWrapper.java:85)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.execute(JUnitCoreWrapper.java:54)
	at org.apache.maven.surefire.junitcore.JUnitCoreProvider.invoke(JUnitCoreProvider.java:134)
	at org.apache.maven.surefire.booter.ForkedBooter.invokeProviderInSameClassLoader(ForkedBooter.java:200)
	at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:153)
	at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:103)

"VM Thread" prio=10 tid=0x64bf8800 nid=0xdcc runnable 

"GC task thread#0 (ParallelGC)" prio=10 tid=0xf6710800 nid=0xdbb runnable 

"GC task thread#1 (ParallelGC)" prio=10 tid=0xf6712000 nid=0xdbc runnable 

"GC task thread#2 (ParallelGC)" prio=10 tid=0xf6713800 nid=0xdbd runnable 

"GC task thread#3 (ParallelGC)" prio=10 tid=0xf6715000 nid=0xdbe runnable 

"GC task thread#4 (ParallelGC)" prio=10 tid=0xf6716400 nid=0xdbf runnable 

"GC task thread#5 (ParallelGC)" prio=10 tid=0xf6717c00 nid=0xdc0 runnable 

"GC task thread#6 (ParallelGC)" prio=10 tid=0xf6719400 nid=0xdc1 runnable 

"GC task thread#7 (ParallelGC)" prio=10 tid=0xf671a800 nid=0xdc2 runnable 

"GC task thread#8 (ParallelGC)" prio=10 tid=0xf671c000 nid=0xdc3 runnable 

"GC task thread#9 (ParallelGC)" prio=10 tid=0xf671d800 nid=0xdc4 runnable 

"GC task thread#10 (ParallelGC)" prio=10 tid=0xf671ec00 nid=0xdc6 runnable 

"GC task thread#11 (ParallelGC)" prio=10 tid=0xf6720400 nid=0xdc7 runnable 

"GC task thread#12 (ParallelGC)" prio=10 tid=0xf6721c00 nid=0xdc8 runnable 

"VM Periodic Task Thread" prio=10 tid=0x64cf8c00 nid=0xdd8 waiting on condition 

JNI global references: 274

+ 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.hadoop.hbase.client.TestAdmin.testShouldCloseTheRegionBasedOnTheEncodedRegionName(TestAdmin.java:1350)
	at org.apache.hadoop.hbase.client.TestAdmin.testCloseRegionWhenEncodedRegionNameIsNotGiven(TestAdmin.java:1484)'
+ BAD=1
+ cut -d ' ' -f 1
+ jps
+ grep surefirebooter
+ xargs kill -9
POST BUILD TASK : SUCCESS
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1787 artifacts
Archive block size is 32768
Received 73 blocks and 625951558 bytes
Compression is 0.4%
Took 4 min 10 sec
Recording test results

Build failed in Jenkins: HBase-TRUNK #5516

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5516/changes>

Changes:

[stack] HBASE-11988 AC/VC system table create on postStartMaster fails too often in test; ADD DEBUG

------------------------------------------
[...truncated 11289 lines...]
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x8167b738> (a sun.nio.ch.Util$2)
	- locked <0x8167b728> (a java.util.Collections$UnmodifiableSet)
	- locked <0x8167b320> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener.run(Server.java:668)

"IPC Server Responder" daemon prio=10 tid=0x60796800 nid=0x4566 runnable [0x62ead000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x8167c120> (a sun.nio.ch.Util$2)
	- locked <0x8167c110> (a java.util.Collections$UnmodifiableSet)
	- locked <0x8167bf10> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.apache.hadoop.ipc.Server$Responder.doRunLoop(Server.java:835)
	at org.apache.hadoop.ipc.Server$Responder.run(Server.java:818)

"org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor@239d58" daemon prio=10 tid=0x60783c00 nid=0x4564 waiting on condition [0x62c5c000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor.run(BlockManager.java:3336)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor@2f32d8" daemon prio=10 tid=0x60782400 nid=0x4563 waiting on condition [0x62cad000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor.run(HeartbeatManager.java:307)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor@186ef3e" daemon prio=10 tid=0x60781000 nid=0x4562 waiting on condition [0x62cfe000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor.run(DecommissionManager.java:76)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor@1ad9f73" daemon prio=10 tid=0x60780000 nid=0x4561 waiting on condition [0x62e5c000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor.run(PendingReplicationBlocks.java:221)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.util.JvmPauseMonitor$Monitor@ad73f4" daemon prio=10 tid=0x6077bc00 nid=0x455b waiting on condition [0x62efe000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.util.JvmPauseMonitor$Monitor.run(JvmPauseMonitor.java:161)
	at java.lang.Thread.run(Thread.java:724)

"IPC Server idle connection scanner for port 53749" daemon prio=10 tid=0x60761400 nid=0x4553 in Object.wait() [0x6385c000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x81677d58> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Socket Reader #1 for port 53749" prio=10 tid=0x6073e000 nid=0x4552 runnable [0x638ad000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x81662dc0> (a sun.nio.ch.Util$2)
	- locked <0x81662db0> (a java.util.Collections$UnmodifiableSet)
	- locked <0x816624d0> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener$Reader.doRunLoop(Server.java:616)
	- locked <0x8167b908> (a org.apache.hadoop.ipc.Server$Listener$Reader)
	at org.apache.hadoop.ipc.Server$Listener$Reader.run(Server.java:595)

"Timer-0" daemon prio=10 tid=0x60b81400 nid=0x44fc in Object.wait() [0x638fe000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7fe844c8> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"14079843@qtp-31167180-1 - Acceptor0 SelectChannelConnector@localhost:42006" daemon prio=10 tid=0x60b63c00 nid=0x44e5 runnable [0x6437d000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x7fe5cdc0> (a sun.nio.ch.Util$2)
	- locked <0x7fe5cdb0> (a java.util.Collections$UnmodifiableSet)
	- locked <0x7fe5c9b0> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.mortbay.io.nio.SelectorManager$SelectSet.doSelect(SelectorManager.java:498)
	at org.mortbay.io.nio.SelectorManager.doSelect(SelectorManager.java:192)
	at org.mortbay.jetty.nio.SelectChannelConnector.accept(SelectChannelConnector.java:124)
	at org.mortbay.jetty.AbstractConnector$Acceptor.run(AbstractConnector.java:708)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:582)

"4424719@qtp-31167180-0" daemon prio=10 tid=0x60b65800 nid=0x44e4 in Object.wait() [0x6457d000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:626)
	- locked <0x7fe5cf98> (a org.mortbay.thread.QueuedThreadPool$PoolThread)

"Timer for 'NameNode' metrics system" daemon prio=10 tid=0x60b11800 nid=0x44b1 in Object.wait() [0x64f52000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7ffaa128> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Service Thread" daemon prio=10 tid=0x64df7000 nid=0x4194 runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread1" daemon prio=10 tid=0x64df5400 nid=0x4193 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread0" daemon prio=10 tid=0x64df3400 nid=0x4192 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Signal Dispatcher" daemon prio=10 tid=0x64df1800 nid=0x4191 runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Finalizer" daemon prio=10 tid=0x64db7000 nid=0x418e in Object.wait() [0x6bd7d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:135)
	- locked <0x7cb72b58> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:151)
	at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:189)

"Reference Handler" daemon prio=10 tid=0x64db5400 nid=0x418d in Object.wait() [0x6bf7d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.Object.wait(Object.java:503)
	at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:133)
	- locked <0x7cb76b60> (a java.lang.ref.Reference$Lock)

"main" prio=10 tid=0xf6806800 nid=0x4178 waiting on condition [0xf6970000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.util.ThreadUtil.sleepAtLeastIgnoreInterrupts(ThreadUtil.java:43)
	at org.apache.hadoop.io.retry.RetryInvocationHandler.invoke(RetryInvocationHandler.java:154)
	at com.sun.proxy.$Proxy89.getNewApplication(Unknown Source)
	at org.apache.hadoop.yarn.client.api.impl.YarnClientImpl.getNewApplication(YarnClientImpl.java:165)
	at org.apache.hadoop.yarn.client.api.impl.YarnClientImpl.createApplication(YarnClientImpl.java:173)
	at org.apache.hadoop.mapred.ResourceMgrDelegate.getNewJobID(ResourceMgrDelegate.java:179)
	at org.apache.hadoop.mapred.YARNRunner.getNewJobID(YARNRunner.java:230)
	at org.apache.hadoop.mapreduce.JobSubmitter.submitJobInternal(JobSubmitter.java:357)
	at org.apache.hadoop.mapreduce.Job$10.run(Job.java:1285)
	at org.apache.hadoop.mapreduce.Job$10.run(Job.java:1282)
	at java.security.AccessController.doPrivileged(Native Method)
	at javax.security.auth.Subject.doAs(Subject.java:415)
	at org.apache.hadoop.security.UserGroupInformation.doAs(UserGroupInformation.java:1548)
	at org.apache.hadoop.mapreduce.Job.submit(Job.java:1282)
	at org.apache.hadoop.mapreduce.Job.waitForCompletion(Job.java:1303)
	at org.apache.hadoop.hbase.mapreduce.TestTableInputFormatScanBase.testScan(TestTableInputFormatScanBase.java:238)
	at org.apache.hadoop.hbase.mapreduce.TestTableInputFormatScan2.testScanYYXToEmpty(TestTableInputFormatScan2.java:84)
	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.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:47)
	at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:12)
	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:44)
	at org.junit.internal.runners.statements.InvokeMethod.evaluate(InvokeMethod.java:17)
	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:271)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:70)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:26)
	at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:27)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runners.Suite.runChild(Suite.java:127)
	at org.junit.runners.Suite.runChild(Suite.java:26)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:160)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:138)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.createRequestAndRun(JUnitCoreWrapper.java:113)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.executeEager(JUnitCoreWrapper.java:85)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.execute(JUnitCoreWrapper.java:54)
	at org.apache.maven.surefire.junitcore.JUnitCoreProvider.invoke(JUnitCoreProvider.java:134)
	at org.apache.maven.surefire.booter.ForkedBooter.invokeProviderInSameClassLoader(ForkedBooter.java:200)
	at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:153)
	at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:103)

"VM Thread" prio=10 tid=0x64cf8800 nid=0x418c runnable 

"GC task thread#0 (ParallelGC)" prio=10 tid=0xf6810800 nid=0x417a runnable 

"GC task thread#1 (ParallelGC)" prio=10 tid=0xf6812000 nid=0x417b runnable 

"GC task thread#2 (ParallelGC)" prio=10 tid=0xf6813800 nid=0x417c runnable 

"GC task thread#3 (ParallelGC)" prio=10 tid=0xf6815000 nid=0x417d runnable 

"GC task thread#4 (ParallelGC)" prio=10 tid=0xf6816400 nid=0x417e runnable 

"GC task thread#5 (ParallelGC)" prio=10 tid=0xf6817c00 nid=0x417f runnable 

"GC task thread#6 (ParallelGC)" prio=10 tid=0xf6819400 nid=0x4180 runnable 

"GC task thread#7 (ParallelGC)" prio=10 tid=0xf681a800 nid=0x4181 runnable 

"GC task thread#8 (ParallelGC)" prio=10 tid=0xf681c000 nid=0x4182 runnable 

"GC task thread#9 (ParallelGC)" prio=10 tid=0xf681d800 nid=0x4183 runnable 

"GC task thread#10 (ParallelGC)" prio=10 tid=0xf681ec00 nid=0x4184 runnable 

"GC task thread#11 (ParallelGC)" prio=10 tid=0xf6820400 nid=0x4185 runnable 

"GC task thread#12 (ParallelGC)" prio=10 tid=0xf6821c00 nid=0x4186 runnable 

"VM Periodic Task Thread" prio=10 tid=0x64df9000 nid=0x4195 waiting on condition 

JNI global references: 450

+ 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.hadoop.hbase.mapreduce.TestTableInputFormatScanBase.testScan(TestTableInputFormatScanBase.java:238)
	at org.apache.hadoop.hbase.mapreduce.TestTableInputFormatScan2.testScanYYXToEmpty(TestTableInputFormatScan2.java:84)'
+ BAD=1
+ jps
+ cut -d ' ' -f 1
+ grep surefirebooter
+ xargs kill -9
POST BUILD TASK : SUCCESS
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1789 artifacts
Archive block size is 32768
Received 73 blocks and 564867837 bytes
Compression is 0.4%
Took 2 min 21 sec
Recording test results
Updating HBASE-11988

Build failed in Jenkins: HBase-TRUNK #5515

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5515/changes>

Changes:

[apurtell] HBASE-11994 PutCombiner floods the M/R log with repeated log messages (Aditya Kishore)

[stack] Add google NYC meetup october 15th

[mstanleyjones] HBASE-11738 Documented improvements to ltt and pe tools

------------------------------------------
[...truncated 1651 lines...]
Tests run: 19, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.51 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithCustomVisLabService
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.242 sec - in org.apache.hadoop.hbase.security.visibility.TestEnforcingScanLabelGenerator
Tests run: 21, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 13.84 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithDefaultVisLabelService
Running org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithDeletes
Tests run: 1, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: -2,134,652.717 sec <<< FAILURE! - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsOpWithDifferentUsersNoACL
org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsOpWithDifferentUsersNoACL  Time elapsed: -2,134,652.718 sec  <<< FAILURE!
java.lang.AssertionError: Timed out waiting for table to become available and enabled hbase:labels
	at org.junit.Assert.fail(Assert.java:88)
	at org.junit.Assert.assertTrue(Assert.java:41)
	at org.apache.hadoop.hbase.HBaseTestingUtility.waitTableEnabled(HBaseTestingUtility.java:2803)
	at org.apache.hadoop.hbase.HBaseTestingUtility.waitTableEnabled(HBaseTestingUtility.java:2793)
	at org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsOpWithDifferentUsersNoACL.setupBeforeClass(TestVisibilityLabelsOpWithDifferentUsersNoACL.java:70)

Running org.apache.hadoop.hbase.TestGlobalMemStoreSize
Running org.apache.hadoop.hbase.security.visibility.TestVisibilityWithCheckAuths
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.959 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityWithCheckAuths
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.187 sec - in org.apache.hadoop.hbase.TestGlobalMemStoreSize
Running org.apache.hadoop.hbase.TestNamespace
Running org.apache.hadoop.hbase.constraint.TestConstraint
Tests run: 9, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 6.081 sec - in org.apache.hadoop.hbase.TestNamespace
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.345 sec - in org.apache.hadoop.hbase.constraint.TestConstraint
Running org.apache.hadoop.hbase.filter.TestFuzzyRowAndColumnRangeFilter
Running org.apache.hadoop.hbase.filter.TestFilterWrapper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.045 sec - in org.apache.hadoop.hbase.filter.TestFuzzyRowAndColumnRangeFilter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.201 sec - in org.apache.hadoop.hbase.filter.TestFilterWrapper
Tests run: 37, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 41.188 sec - in org.apache.hadoop.hbase.security.visibility.TestVisibilityLabelsWithDeletes
Running org.apache.hadoop.hbase.TestHBaseTestingUtility
Running org.apache.hadoop.hbase.filter.TestColumnRangeFilter
Running org.apache.hadoop.hbase.filter.TestFilterWithScanLimits
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.112 sec - in org.apache.hadoop.hbase.filter.TestFilterWithScanLimits
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 8.376 sec - in org.apache.hadoop.hbase.filter.TestColumnRangeFilter
Running org.apache.hadoop.hbase.io.encoding.TestDataBlockEncoders
Running org.apache.hadoop.hbase.io.encoding.TestChangingEncoding
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 24.587 sec - in org.apache.hadoop.hbase.TestHBaseTestingUtility
Running org.apache.hadoop.hbase.io.encoding.TestEncodedSeekers
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 51.928 sec - in org.apache.hadoop.hbase.io.encoding.TestChangingEncoding
Running org.apache.hadoop.hbase.io.encoding.TestPrefixTree
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.673 sec - in org.apache.hadoop.hbase.io.encoding.TestPrefixTree
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 279.612 sec - in org.apache.hadoop.hbase.snapshot.TestSecureExportSnapshot
Running org.apache.hadoop.hbase.io.encoding.TestBufferedDataBlockEncoder
Running org.apache.hadoop.hbase.io.encoding.TestLoadAndSwitchEncodeOnDisk
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 277.071 sec - in org.apache.hadoop.hbase.snapshot.TestExportSnapshot
Running org.apache.hadoop.hbase.io.hfile.TestScannerSelectionUsingTTL
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 20.014 sec - in org.apache.hadoop.hbase.io.encoding.TestLoadAndSwitchEncodeOnDisk
Running org.apache.hadoop.hbase.io.hfile.TestHFileBlock
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.258 sec - in org.apache.hadoop.hbase.io.encoding.TestBufferedDataBlockEncoder
Running org.apache.hadoop.hbase.io.hfile.TestCacheOnWrite
Tests run: 20, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 124.688 sec - in org.apache.hadoop.hbase.io.encoding.TestEncodedSeekers
Running org.apache.hadoop.hbase.io.hfile.TestHFileBlockIndex
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.076 sec - in org.apache.hadoop.hbase.io.hfile.TestHFileBlockIndex
Running org.apache.hadoop.hbase.io.hfile.TestHFileSeek
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 62.774 sec - in org.apache.hadoop.hbase.io.hfile.TestScannerSelectionUsingTTL
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.854 sec - in org.apache.hadoop.hbase.io.hfile.TestHFileSeek
Running org.apache.hadoop.hbase.io.hfile.TestCacheConfig
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.117 sec - in org.apache.hadoop.hbase.io.hfile.TestCacheConfig
Running org.apache.hadoop.hbase.io.hfile.TestForceCacheImportantBlocks
Running org.apache.hadoop.hbase.io.TestFileLink
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 15.648 sec - in org.apache.hadoop.hbase.io.TestFileLink
Running org.apache.hadoop.hbase.procedure.TestZKProcedure
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.209 sec - in org.apache.hadoop.hbase.procedure.TestZKProcedure
Running org.apache.hadoop.hbase.procedure.TestZKProcedureControllers
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.692 sec - in org.apache.hadoop.hbase.procedure.TestZKProcedureControllers
Running org.apache.hadoop.hbase.ipc.TestHBaseClient
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.42 sec - in org.apache.hadoop.hbase.ipc.TestHBaseClient
Running org.apache.hadoop.hbase.ipc.TestDelayedRpc
Tests run: 28, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 92.989 sec - in org.apache.hadoop.hbase.io.hfile.TestHFileBlock
Running org.apache.hadoop.hbase.ipc.TestProtoBufRpc
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.818 sec - in org.apache.hadoop.hbase.ipc.TestDelayedRpc
Running org.apache.hadoop.hbase.TestLocalHBaseCluster
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.65 sec - in org.apache.hadoop.hbase.ipc.TestProtoBufRpc
Running org.apache.hadoop.hbase.TestAcidGuarantees
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.235 sec - in org.apache.hadoop.hbase.TestLocalHBaseCluster
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 46.311 sec - in org.apache.hadoop.hbase.io.hfile.TestForceCacheImportantBlocks
Running org.apache.hadoop.hbase.zookeeper.TestRecoverableZooKeeper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.263 sec - in org.apache.hadoop.hbase.zookeeper.TestRecoverableZooKeeper
Running org.apache.hadoop.hbase.zookeeper.TestZooKeeperACL
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.264 sec - in org.apache.hadoop.hbase.zookeeper.TestZooKeeperACL
Running org.apache.hadoop.hbase.zookeeper.TestZooKeeperNodeTracker
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.996 sec - in org.apache.hadoop.hbase.zookeeper.TestZooKeeperNodeTracker
Running org.apache.hadoop.hbase.zookeeper.TestHQuorumPeer
Running org.apache.hadoop.hbase.zookeeper.TestZKLeaderManager
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.135 sec - in org.apache.hadoop.hbase.zookeeper.TestZKLeaderManager
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.664 sec - in org.apache.hadoop.hbase.zookeeper.TestHQuorumPeer
Running org.apache.hadoop.hbase.zookeeper.TestZKMulti
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.352 sec - in org.apache.hadoop.hbase.zookeeper.TestZKMulti
Running org.apache.hadoop.hbase.zookeeper.lock.TestZKInterProcessReadWriteLock
Running org.apache.hadoop.hbase.TestJMXListener
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.403 sec - in org.apache.hadoop.hbase.TestJMXListener
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 24.465 sec - in org.apache.hadoop.hbase.zookeeper.lock.TestZKInterProcessReadWriteLock
Running org.apache.hadoop.hbase.TestMetaTableAccessorNoCluster
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.718 sec - in org.apache.hadoop.hbase.TestMetaTableAccessorNoCluster
Running org.apache.hadoop.hbase.TestZooKeeper
Tests run: 72, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 148.754 sec - in org.apache.hadoop.hbase.io.hfile.TestCacheOnWrite
Running org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpoint
Running org.apache.hadoop.hbase.replication.regionserver.TestReplicationHLogReaderManager
Tests run: 28, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 274.233 sec - in org.apache.hadoop.hbase.io.encoding.TestDataBlockEncoders
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 87.86 sec - in org.apache.hadoop.hbase.TestAcidGuarantees
Running org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpointNoMaster
Running org.apache.hadoop.hbase.replication.regionserver.TestReplicationSink
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.904 sec - in org.apache.hadoop.hbase.replication.regionserver.TestReplicationSink
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 40.339 sec - in org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpoint
Running org.apache.hadoop.hbase.replication.regionserver.TestReplicationSourceManager
Running org.apache.hadoop.hbase.replication.TestReplicationTrackerZKImpl
Tests run: 4, Failures: 0, Errors: 0, Skipped: 2, Time elapsed: 0.817 sec - in org.apache.hadoop.hbase.replication.TestReplicationTrackerZKImpl
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.355 sec - in org.apache.hadoop.hbase.replication.regionserver.TestReplicationSourceManager
Running org.apache.hadoop.hbase.replication.TestReplicationKillMasterRSCompressed
Running org.apache.hadoop.hbase.replication.TestReplicationKillMasterRS
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 34.319 sec - in org.apache.hadoop.hbase.replication.regionserver.TestRegionReplicaReplicationEndpointNoMaster
Running org.apache.hadoop.hbase.replication.TestMultiSlaveReplication
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 15.716 sec - in org.apache.hadoop.hbase.replication.TestReplicationKillMasterRSCompressed
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.058 sec - in org.apache.hadoop.hbase.replication.TestReplicationKillMasterRS
Running org.apache.hadoop.hbase.replication.TestReplicationChangingPeerRegionservers
Running org.apache.hadoop.hbase.replication.TestReplicationKillSlaveRS
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.212 sec - in org.apache.hadoop.hbase.replication.TestReplicationChangingPeerRegionservers
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 21.416 sec - in org.apache.hadoop.hbase.replication.TestMultiSlaveReplication
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 13.501 sec - in org.apache.hadoop.hbase.replication.TestReplicationKillSlaveRS
Running org.apache.hadoop.hbase.replication.TestMasterReplication
Running org.apache.hadoop.hbase.replication.TestPerTableCFReplication
Running org.apache.hadoop.hbase.replication.TestReplicationDisableInactivePeer
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 19.104 sec - in org.apache.hadoop.hbase.replication.TestReplicationDisableInactivePeer
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 26.468 sec - in org.apache.hadoop.hbase.replication.TestPerTableCFReplication
Running org.apache.hadoop.hbase.replication.TestReplicationWithTags
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 41.358 sec - in org.apache.hadoop.hbase.replication.TestMasterReplication
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.238 sec - in org.apache.hadoop.hbase.replication.TestReplicationWithTags
Running org.apache.hadoop.hbase.replication.TestReplicationEndpoint
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.355 sec - in org.apache.hadoop.hbase.replication.TestReplicationEndpoint
Running org.apache.hadoop.hbase.replication.TestReplicationSource
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.467 sec - in org.apache.hadoop.hbase.replication.TestReplicationSource
Running org.apache.hadoop.hbase.replication.TestReplicationStateZKImpl
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.842 sec - in org.apache.hadoop.hbase.replication.TestReplicationStateZKImpl
Running org.apache.hadoop.hbase.fs.TestBlockReorder
Running org.apache.hadoop.hbase.replication.TestReplicationSmallTests
Running org.apache.hadoop.hbase.replication.TestReplicationSyncUpTool
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 20.668 sec - in org.apache.hadoop.hbase.fs.TestBlockReorder
Running org.apache.hadoop.hbase.trace.TestHTraceHooks
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.803 sec - in org.apache.hadoop.hbase.trace.TestHTraceHooks
Tests run: 11, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 198.76 sec - in org.apache.hadoop.hbase.TestZooKeeper
Running org.apache.hadoop.hbase.TestMetaTableLocator
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 36.387 sec - in org.apache.hadoop.hbase.replication.TestReplicationSmallTests
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.708 sec - in org.apache.hadoop.hbase.TestMetaTableLocator
Running org.apache.hadoop.hbase.mapred.TestTableSnapshotInputFormat
Running org.apache.hadoop.hbase.mapred.TestTableInputFormat
Tests run: 10, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.707 sec - in org.apache.hadoop.hbase.mapred.TestTableInputFormat
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 46.586 sec - in org.apache.hadoop.hbase.replication.TestReplicationSyncUpTool
Running org.apache.hadoop.hbase.mapred.TestTableMapReduceUtil
Running org.apache.hadoop.hbase.TestMultiVersions
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.292 sec - in org.apache.hadoop.hbase.TestMultiVersions
Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 230.598 sec - in org.apache.hadoop.hbase.replication.regionserver.TestReplicationHLogReaderManager
Running org.apache.hadoop.hbase.mapred.TestTableMapReduce
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 89.867 sec - in org.apache.hadoop.hbase.mapred.TestTableMapReduceUtil
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 95.998 sec - in org.apache.hadoop.hbase.mapred.TestTableMapReduce
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 250.793 sec - in org.apache.hadoop.hbase.mapred.TestTableSnapshotInputFormat

Results :

Failed tests: 
  TestTablePermissions.beforeClass:101 Timed out waiting for table to become available and enabled hbase:acl
  TestNamespaceCommands.beforeClass:80 Timed out waiting for table to become available hbase:acl
  TestVisibilityLabelsOpWithDifferentUsersNoACL.setupBeforeClass:70 Timed out waiting for table to become available and enabled hbase:labels

Tests in error: 
  TestNamespaceCommands.afterClass:94 ? NamespaceNotFound org.apache.hadoop.hbas...

Tests run: 2000, Failures: 3, Errors: 1, Skipped: 19

[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO] 
[INFO] HBase ............................................. SUCCESS [2.539s]
[INFO] HBase - Common .................................... SUCCESS [58.236s]
[INFO] HBase - Protocol .................................. SUCCESS [9.043s]
[INFO] HBase - Client .................................... SUCCESS [1:03.981s]
[INFO] HBase - Hadoop Compatibility ...................... SUCCESS [7.042s]
[INFO] HBase - Hadoop Two Compatibility .................. SUCCESS [5.820s]
[INFO] HBase - Prefix Tree ............................... SUCCESS [8.404s]
[INFO] HBase - Server .................................... FAILURE [1:01:14.618s]
[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: 1:03:50.474s
[INFO] Finished at: Tue Sep 16 23:32:20 UTC 2014
[INFO] Final Memory: 40M/209M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.17:test (secondPartTestsExecution) on project hbase-server: There are test failures.
[ERROR] 
[ERROR] Please refer to <https://builds.apache.org/job/HBase-TRUNK/ws/hbase-server/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 :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-TRUNK] $ /bin/bash -xe /tmp/hudson6986802573910535800.sh
++ jps
++ grep surefirebooter
++ wc -l
+ ZOMBIE_TESTS_COUNT=0
+ [[ 0 != 0 ]]
+ echo 'We'\''re ok: there is no zombie test'
We're ok: there is no zombie test
POST BUILD TASK : SUCCESS
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1788 artifacts
Archive block size is 32768
Received 73 blocks and 564613683 bytes
Compression is 0.4%
Took 2 min 36 sec
Recording test results
Updating HBASE-11738
Updating HBASE-11994

Build failed in Jenkins: HBase-TRUNK #5514

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-TRUNK/5514/changes>

Changes:

[enis] HBASE-11989 IntegrationTestLoadAndVerify cannot be configured anymore on distributed mode

------------------------------------------
[...truncated 8830 lines...]
	at java.util.concurrent.LinkedBlockingQueue.poll(LinkedBlockingQueue.java:467)
	at org.apache.hadoop.ipc.CallQueueManager.take(CallQueueManager.java:109)
	at org.apache.hadoop.ipc.Server$Handler.run(Server.java:1985)

"IPC Server listener on 46700" daemon prio=10 tid=0x60d37000 nid=0x7792 runnable [0x607ad000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x7fe80d88> (a sun.nio.ch.Util$2)
	- locked <0x7fe80d78> (a java.util.Collections$UnmodifiableSet)
	- locked <0x7fe809a0> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener.run(Server.java:668)

"IPC Server Responder" daemon prio=10 tid=0x60d36000 nid=0x7791 runnable [0x62a5c000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x80288708> (a sun.nio.ch.Util$2)
	- locked <0x802886f8> (a java.util.Collections$UnmodifiableSet)
	- locked <0x802884f8> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.apache.hadoop.ipc.Server$Responder.doRunLoop(Server.java:835)
	at org.apache.hadoop.ipc.Server$Responder.run(Server.java:818)

"org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor@f649f2" daemon prio=10 tid=0x60d2d400 nid=0x776e waiting on condition [0x607fe000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.BlockManager$ReplicationMonitor.run(BlockManager.java:3336)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor@170e5ba" daemon prio=10 tid=0x60d2bc00 nid=0x776c waiting on condition [0x61c5b000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.HeartbeatManager$Monitor.run(HeartbeatManager.java:307)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor@80bcee" daemon prio=10 tid=0x60d2a800 nid=0x776b waiting on condition [0x61cac000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor.run(DecommissionManager.java:76)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor@1b3c96d" daemon prio=10 tid=0x60d29800 nid=0x7767 waiting on condition [0x61cfd000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor.run(PendingReplicationBlocks.java:221)
	at java.lang.Thread.run(Thread.java:724)

"org.apache.hadoop.util.JvmPauseMonitor$Monitor@17eaf74" daemon prio=10 tid=0x60d24c00 nid=0x7732 waiting on condition [0x62aad000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.util.JvmPauseMonitor$Monitor.run(JvmPauseMonitor.java:161)
	at java.lang.Thread.run(Thread.java:724)

"IPC Server idle connection scanner for port 46700" daemon prio=10 tid=0x60ee9000 nid=0x771a in Object.wait() [0x62afe000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7fe73aa8> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Socket Reader #1 for port 46700" prio=10 tid=0x60ef7400 nid=0x7713 runnable [0x6365c000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x8028c128> (a sun.nio.ch.Util$2)
	- locked <0x8028c118> (a java.util.Collections$UnmodifiableSet)
	- locked <0x7fe741a8> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:102)
	at org.apache.hadoop.ipc.Server$Listener$Reader.doRunLoop(Server.java:616)
	- locked <0x80288160> (a org.apache.hadoop.ipc.Server$Listener$Reader)
	at org.apache.hadoop.ipc.Server$Listener$Reader.run(Server.java:595)

"Timer-0" daemon prio=10 tid=0x60e20000 nid=0x75f8 in Object.wait() [0x636ad000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7ee33580> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"27543380@qtp-20972316-1" daemon prio=10 tid=0x60e04c00 nid=0x75e3 in Object.wait() [0x636fe000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:626)
	- locked <0x7ed8f9d0> (a org.mortbay.thread.QueuedThreadPool$PoolThread)

"28368186@qtp-20972316-0 - Acceptor0 SelectChannelConnector@localhost:34234" daemon prio=10 tid=0x60e06000 nid=0x75df runnable [0x6477d000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:228)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:81)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:87)
	- locked <0x7ed90a10> (a sun.nio.ch.Util$2)
	- locked <0x7ed90a00> (a java.util.Collections$UnmodifiableSet)
	- locked <0x7ed90600> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:98)
	at org.mortbay.io.nio.SelectorManager$SelectSet.doSelect(SelectorManager.java:498)
	at org.mortbay.io.nio.SelectorManager.doSelect(SelectorManager.java:192)
	at org.mortbay.jetty.nio.SelectChannelConnector.accept(SelectChannelConnector.java:124)
	at org.mortbay.jetty.AbstractConnector$Acceptor.run(AbstractConnector.java:708)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:582)

"Timer for 'NameNode' metrics system" daemon prio=10 tid=0x627b1800 nid=0x75a6 in Object.wait() [0x6437d000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:552)
	- locked <0x7ed88250> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:505)

"Service Thread" daemon prio=10 tid=0x64df6c00 nid=0x72ca runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread1" daemon prio=10 tid=0x64df5400 nid=0x72c6 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread0" daemon prio=10 tid=0x64df3400 nid=0x72c0 waiting on condition [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Signal Dispatcher" daemon prio=10 tid=0x64df1800 nid=0x72be runnable [0x00000000]
   java.lang.Thread.State: RUNNABLE

"Finalizer" daemon prio=10 tid=0x64db7000 nid=0x7296 in Object.wait() [0x6bd7d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	- waiting on <0x7cb188c8> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:135)
	- locked <0x7cb188c8> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:151)
	at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:189)

"Reference Handler" daemon prio=10 tid=0x64db5400 nid=0x7294 in Object.wait() [0x6c07d000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	- waiting on <0x7cb18410> (a java.lang.ref.Reference$Lock)
	at java.lang.Object.wait(Object.java:503)
	at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:133)
	- locked <0x7cb18410> (a java.lang.ref.Reference$Lock)

"main" prio=10 tid=0xf6706800 nid=0x7270 waiting on condition [0xf6935000]
   java.lang.Thread.State: TIMED_WAITING (sleeping)
	at java.lang.Thread.sleep(Native Method)
	at org.apache.hadoop.util.ThreadUtil.sleepAtLeastIgnoreInterrupts(ThreadUtil.java:43)
	at org.apache.hadoop.io.retry.RetryInvocationHandler.invoke(RetryInvocationHandler.java:154)
	at com.sun.proxy.$Proxy89.getNewApplication(Unknown Source)
	at org.apache.hadoop.yarn.client.api.impl.YarnClientImpl.getNewApplication(YarnClientImpl.java:165)
	at org.apache.hadoop.yarn.client.api.impl.YarnClientImpl.createApplication(YarnClientImpl.java:173)
	at org.apache.hadoop.mapred.ResourceMgrDelegate.getNewJobID(ResourceMgrDelegate.java:179)
	at org.apache.hadoop.mapred.YARNRunner.getNewJobID(YARNRunner.java:230)
	at org.apache.hadoop.mapreduce.JobSubmitter.submitJobInternal(JobSubmitter.java:357)
	at org.apache.hadoop.mapreduce.Job$10.run(Job.java:1285)
	at org.apache.hadoop.mapreduce.Job$10.run(Job.java:1282)
	at java.security.AccessController.doPrivileged(Native Method)
	at javax.security.auth.Subject.doAs(Subject.java:415)
	at org.apache.hadoop.security.UserGroupInformation.doAs(UserGroupInformation.java:1548)
	at org.apache.hadoop.mapreduce.Job.submit(Job.java:1282)
	at org.apache.hadoop.mapreduce.Job.waitForCompletion(Job.java:1303)
	at org.apache.hadoop.hbase.mapreduce.ImportTsv.run(ImportTsv.java:614)
	at org.apache.hadoop.util.ToolRunner.run(ToolRunner.java:70)
	at org.apache.hadoop.hbase.mapreduce.TestImportTSVWithOperationAttributes.doMROnTableTest(TestImportTSVWithOperationAttributes.java:178)
	at org.apache.hadoop.hbase.mapreduce.TestImportTSVWithOperationAttributes.testMROnTable(TestImportTSVWithOperationAttributes.java:124)
	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.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:47)
	at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:12)
	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:44)
	at org.junit.internal.runners.statements.InvokeMethod.evaluate(InvokeMethod.java:17)
	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:271)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:70)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:50)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:26)
	at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:27)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runners.Suite.runChild(Suite.java:127)
	at org.junit.runners.Suite.runChild(Suite.java:26)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:238)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:63)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:236)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:53)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:229)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:309)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:160)
	at org.junit.runner.JUnitCore.run(JUnitCore.java:138)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.createRequestAndRun(JUnitCoreWrapper.java:113)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.executeEager(JUnitCoreWrapper.java:85)
	at org.apache.maven.surefire.junitcore.JUnitCoreWrapper.execute(JUnitCoreWrapper.java:54)
	at org.apache.maven.surefire.junitcore.JUnitCoreProvider.invoke(JUnitCoreProvider.java:134)
	at org.apache.maven.surefire.booter.ForkedBooter.invokeProviderInSameClassLoader(ForkedBooter.java:200)
	at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:153)
	at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:103)

"VM Thread" prio=10 tid=0x64cf8800 nid=0x7290 runnable 

"GC task thread#0 (ParallelGC)" prio=10 tid=0xf6710800 nid=0x7272 runnable 

"GC task thread#1 (ParallelGC)" prio=10 tid=0xf6712000 nid=0x7273 runnable 

"GC task thread#2 (ParallelGC)" prio=10 tid=0xf6713800 nid=0x7279 runnable 

"GC task thread#3 (ParallelGC)" prio=10 tid=0xf6715000 nid=0x727b runnable 

"GC task thread#4 (ParallelGC)" prio=10 tid=0xf6716400 nid=0x727e runnable 

"GC task thread#5 (ParallelGC)" prio=10 tid=0xf6717c00 nid=0x727f runnable 

"GC task thread#6 (ParallelGC)" prio=10 tid=0xf6719400 nid=0x7280 runnable 

"GC task thread#7 (ParallelGC)" prio=10 tid=0xf671a800 nid=0x7281 runnable 

"GC task thread#8 (ParallelGC)" prio=10 tid=0xf671c000 nid=0x7282 runnable 

"GC task thread#9 (ParallelGC)" prio=10 tid=0xf671d800 nid=0x7283 runnable 

"GC task thread#10 (ParallelGC)" prio=10 tid=0xf671ec00 nid=0x7284 runnable 

"GC task thread#11 (ParallelGC)" prio=10 tid=0xf6720400 nid=0x7285 runnable 

"GC task thread#12 (ParallelGC)" prio=10 tid=0xf6721c00 nid=0x7286 runnable 

"VM Periodic Task Thread" prio=10 tid=0x64df8c00 nid=0x72cc waiting on condition 

JNI global references: 320

POST BUILD TASK : FAILURE
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-TRUNK #5500
Archived 1774 artifacts
Archive block size is 32768
Received 73 blocks and 531141634 bytes
Compression is 0.4%
Took 3 min 5 sec
Recording test results
Updating HBASE-11989