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 2015/07/22 18:04:19 UTC

Build failed in Jenkins: HBase-1.2 » latest1.7,Hadoop #79

See <https://builds.apache.org/job/HBase-1.2/jdk=latest1.7,label=Hadoop/79/changes>

Changes:

[tedyu] HBASE-14115 Fix resource leak in HMasterCommandLine (Yuhao Bi)

------------------------------------------
[...truncated 44229 lines...]
Running org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithAbort
Running org.apache.hadoop.hbase.coprocessor.TestBatchCoprocessorEndpoint
Running org.apache.hadoop.hbase.coprocessor.TestOpenTableInCoprocessor
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.734 sec - in org.apache.hadoop.hbase.coprocessor.TestBatchCoprocessorEndpoint
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 18.286 sec - in org.apache.hadoop.hbase.coprocessor.TestMasterCoprocessorExceptionWithAbort
Running org.apache.hadoop.hbase.coprocessor.TestCoprocessorStop
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 199.734 sec - in org.apache.hadoop.hbase.mapreduce.TestImportTSVWithVisibilityLabels
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 17.71 sec - in org.apache.hadoop.hbase.coprocessor.TestOpenTableInCoprocessor
Running org.apache.hadoop.hbase.coprocessor.TestClassLoading
Running org.apache.hadoop.hbase.TestLocalHBaseCluster
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16 sec - in org.apache.hadoop.hbase.coprocessor.TestCoprocessorStop
Running org.apache.hadoop.hbase.TestNamespace
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 10.196 sec - in org.apache.hadoop.hbase.TestLocalHBaseCluster
Running org.apache.hadoop.hbase.TestMultiVersions
Running org.apache.hadoop.hbase.TestMetaTableAccessor
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 28.897 sec - in org.apache.hadoop.hbase.coprocessor.TestClassLoading
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 9.159 sec - in org.apache.hadoop.hbase.TestMultiVersions
Running org.apache.hadoop.hbase.TestMetaTableLocator
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.776 sec - in org.apache.hadoop.hbase.TestMetaTableLocator
Tests run: 9, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 25.543 sec - in org.apache.hadoop.hbase.TestNamespace
Tests run: 13, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 15.429 sec - in org.apache.hadoop.hbase.TestMetaTableAccessor
Running org.apache.hadoop.hbase.trace.TestHTraceHooks
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.239 sec - in org.apache.hadoop.hbase.trace.TestHTraceHooks
Running org.apache.hadoop.hbase.snapshot.TestFlushSnapshotFromClient
Running org.apache.hadoop.hbase.snapshot.TestRestoreFlushSnapshotFromClient
Running org.apache.hadoop.hbase.snapshot.TestExportSnapshot
Running org.apache.hadoop.hbase.snapshot.TestSecureExportSnapshot
Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 413.49 sec - in org.apache.hadoop.hbase.mapreduce.TestImportExport
Running org.apache.hadoop.hbase.snapshot.TestSnapshotClientRetries
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 19.76 sec - in org.apache.hadoop.hbase.snapshot.TestSnapshotClientRetries
Running org.apache.hadoop.hbase.snapshot.TestSnapshotDescriptionUtils
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.222 sec - in org.apache.hadoop.hbase.snapshot.TestSnapshotDescriptionUtils
Running org.apache.hadoop.hbase.TestMetaMigrationConvertingToPB
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.704 sec - in org.apache.hadoop.hbase.TestMetaMigrationConvertingToPB
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 71.37 sec - in org.apache.hadoop.hbase.snapshot.TestRestoreFlushSnapshotFromClient
Running org.apache.hadoop.hbase.TestMovedRegionsCleaner
Running org.apache.hadoop.hbase.TestPartialResultsFromClientSide
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 80.214 sec - in org.apache.hadoop.hbase.snapshot.TestFlushSnapshotFromClient
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 10.532 sec - in org.apache.hadoop.hbase.TestMovedRegionsCleaner
Running org.apache.hadoop.hbase.quotas.TestQuotaTableUtil
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.742 sec - in org.apache.hadoop.hbase.quotas.TestQuotaTableUtil
Running org.apache.hadoop.hbase.quotas.TestQuotaAdmin
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.207 sec - in org.apache.hadoop.hbase.quotas.TestQuotaAdmin
Running org.apache.hadoop.hbase.util.TestMiniClusterLoadParallel
Running org.apache.hadoop.hbase.quotas.TestQuotaThrottle
Tests run: 13, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 53.316 sec - in org.apache.hadoop.hbase.TestPartialResultsFromClientSide
Running org.apache.hadoop.hbase.util.TestIdLock
Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 26.444 sec - in org.apache.hadoop.hbase.quotas.TestQuotaThrottle
Running org.apache.hadoop.hbase.util.TestHBaseFsck
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 15.426 sec - in org.apache.hadoop.hbase.util.TestIdLock
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 47.956 sec - in org.apache.hadoop.hbase.util.TestMiniClusterLoadParallel
Running org.apache.hadoop.hbase.util.TestMergeTable
Running org.apache.hadoop.hbase.util.TestFSTableDescriptors
Tests run: 15, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.654 sec - in org.apache.hadoop.hbase.util.TestFSTableDescriptors
Running org.apache.hadoop.hbase.util.TestMiniClusterLoadSequential
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.185 sec - in org.apache.hadoop.hbase.util.TestMergeTable
Running org.apache.hadoop.hbase.util.TestConnectionCache
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 17.474 sec - in org.apache.hadoop.hbase.util.TestConnectionCache
Running org.apache.hadoop.hbase.util.TestDefaultEnvironmentEdge
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.379 sec - in org.apache.hadoop.hbase.util.TestDefaultEnvironmentEdge
Running org.apache.hadoop.hbase.util.TestFSVisitor
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.127 sec - in org.apache.hadoop.hbase.util.TestFSVisitor
Running org.apache.hadoop.hbase.util.TestTableName
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.627 sec - in org.apache.hadoop.hbase.util.TestTableName
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 50.502 sec - in org.apache.hadoop.hbase.util.TestMiniClusterLoadSequential
Running org.apache.hadoop.hbase.util.TestHBaseFsckEncryption
Running org.apache.hadoop.hbase.util.TestFSHDFSUtils
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.958 sec - in org.apache.hadoop.hbase.util.TestFSHDFSUtils
Running org.apache.hadoop.hbase.util.TestMiniClusterLoadEncoded
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 13.584 sec - in org.apache.hadoop.hbase.util.TestHBaseFsckEncryption
Running org.apache.hadoop.hbase.util.TestProcessBasedCluster
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.113 sec - in org.apache.hadoop.hbase.util.TestProcessBasedCluster
Running org.apache.hadoop.hbase.util.hbck.TestOfflineMetaRebuildOverlap
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.241 sec - in org.apache.hadoop.hbase.util.hbck.TestOfflineMetaRebuildOverlap
Running org.apache.hadoop.hbase.util.hbck.TestOfflineMetaRebuildBase
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 49.055 sec - in org.apache.hadoop.hbase.util.TestMiniClusterLoadEncoded
Running org.apache.hadoop.hbase.util.hbck.TestOfflineMetaRebuildHole
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.385 sec - in org.apache.hadoop.hbase.util.hbck.TestOfflineMetaRebuildBase
Running org.apache.hadoop.hbase.util.TestMergeTool
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 24.272 sec - in org.apache.hadoop.hbase.util.hbck.TestOfflineMetaRebuildHole
Running org.apache.hadoop.hbase.util.TestFSUtils
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 21.048 sec - in org.apache.hadoop.hbase.util.TestMergeTool
Tests run: 10, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 14.228 sec - in org.apache.hadoop.hbase.util.TestFSUtils
Running org.apache.hadoop.hbase.util.TestCoprocessorScanPolicy
Running org.apache.hadoop.hbase.util.TestRegionSplitter
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.465 sec - in org.apache.hadoop.hbase.util.TestRegionSplitter
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 15.15 sec - in org.apache.hadoop.hbase.util.TestCoprocessorScanPolicy
Running org.apache.hadoop.hbase.wal.TestDefaultWALProvider
Running org.apache.hadoop.hbase.TestFullLogReconstruction
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.078 sec - in org.apache.hadoop.hbase.wal.TestDefaultWALProvider
Running org.apache.hadoop.hbase.wal.TestBoundedRegionGroupingProvider
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 327.382 sec - in org.apache.hadoop.hbase.snapshot.TestExportSnapshot
Running org.apache.hadoop.hbase.wal.TestWALSplit
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 332.493 sec - in org.apache.hadoop.hbase.snapshot.TestSecureExportSnapshot
Running org.apache.hadoop.hbase.wal.TestWALFactory
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 20.093 sec - in org.apache.hadoop.hbase.wal.TestBoundedRegionGroupingProvider
Running org.apache.hadoop.hbase.wal.TestSecureWAL
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.35 sec - in org.apache.hadoop.hbase.wal.TestSecureWAL
Running org.apache.hadoop.hbase.wal.TestWALSplitCompressed
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 38.2 sec - in org.apache.hadoop.hbase.TestFullLogReconstruction
Tests run: 9, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.585 sec - in org.apache.hadoop.hbase.wal.TestWALFactory
Running org.apache.hadoop.hbase.wal.TestWALFiltering
Running org.apache.hadoop.hbase.wal.TestWALReaderOnSecureWAL
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.832 sec - in org.apache.hadoop.hbase.wal.TestWALReaderOnSecureWAL
Running org.apache.hadoop.hbase.wal.TestDefaultWALProviderWithHLogKey
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.016 sec - in org.apache.hadoop.hbase.wal.TestDefaultWALProviderWithHLogKey
Running org.apache.hadoop.hbase.TestHBaseOnOtherDfsCluster
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 25.908 sec - in org.apache.hadoop.hbase.wal.TestWALFiltering
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 11.222 sec - in org.apache.hadoop.hbase.TestHBaseOnOtherDfsCluster
Running org.apache.hadoop.hbase.TestServerSideScanMetricsFromClientSide
Running org.apache.hadoop.hbase.TestZooKeeper
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.952 sec - in org.apache.hadoop.hbase.TestServerSideScanMetricsFromClientSide
Running org.apache.hadoop.hbase.filter.TestFuzzyRowFilterEndToEnd
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 52.978 sec - in org.apache.hadoop.hbase.filter.TestFuzzyRowFilterEndToEnd
Running org.apache.hadoop.hbase.filter.TestFilterWithScanLimits
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.006 sec - in org.apache.hadoop.hbase.filter.TestFilterWithScanLimits
Running org.apache.hadoop.hbase.filter.TestColumnRangeFilter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 7.691 sec - in org.apache.hadoop.hbase.filter.TestColumnRangeFilter
Tests run: 51, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 374.186 sec - in org.apache.hadoop.hbase.util.TestHBaseFsck
Running org.apache.hadoop.hbase.filter.TestMultiRowRangeFilter
Running org.apache.hadoop.hbase.filter.TestFilterWrapper
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 4.45 sec - in org.apache.hadoop.hbase.filter.TestFilterWrapper
Tests run: 31, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 192.414 sec - in org.apache.hadoop.hbase.wal.TestWALSplit
Tests run: 19, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 21.003 sec - in org.apache.hadoop.hbase.filter.TestMultiRowRangeFilter
Running org.apache.hadoop.hbase.filter.TestFuzzyRowAndColumnRangeFilter
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 3.884 sec - in org.apache.hadoop.hbase.filter.TestFuzzyRowAndColumnRangeFilter
Running org.apache.hadoop.hbase.filter.TestScanRowPrefix
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 5.204 sec - in org.apache.hadoop.hbase.filter.TestScanRowPrefix
Tests run: 31, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 193.87 sec - in org.apache.hadoop.hbase.wal.TestWALSplitCompressed
Tests run: 12, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 171.963 sec - in org.apache.hadoop.hbase.TestZooKeeper

Results :


Tests in error: 
  TestHFileOutputFormat2.testMRIncrementalLoadWithSplit:381->doIncrementalLoadTest:442 » IO

Flaked tests: 
org.apache.hadoop.hbase.client.TestSnapshotCloneIndependence.testOnlineSnapshotDeleteIndependent(org.apache.hadoop.hbase.client.TestSnapshotCloneIndependence)
  Run 1: TestSnapshotCloneIndependence.testOnlineSnapshotDeleteIndependent:182->runTestSnapshotDeleteIndependent:425 expected:<17576> but was:<14046>
  Run 2: PASS


Tests run: 2656, Failures: 0, Errors: 1, Skipped: 20, Flakes: 1

[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO] 
[INFO] HBase ............................................. SUCCESS [1:25.153s]
[INFO] HBase - Checkstyle ................................ SUCCESS [10.018s]
[INFO] HBase - Annotations ............................... SUCCESS [0.893s]
[INFO] HBase - Protocol .................................. SUCCESS [17.238s]
[INFO] HBase - Common .................................... SUCCESS [5:18.448s]
[INFO] HBase - Procedure ................................. SUCCESS [1:52.393s]
[INFO] HBase - Client .................................... SUCCESS [1:38.097s]
[INFO] HBase - Hadoop Compatibility ...................... SUCCESS [9.084s]
[INFO] HBase - Hadoop Two Compatibility .................. SUCCESS [12.900s]
[INFO] HBase - Prefix Tree ............................... SUCCESS [9.080s]
[INFO] HBase - Server .................................... FAILURE [1:32:13.593s]
[INFO] HBase - Testing Util .............................. SKIPPED
[INFO] HBase - Thrift .................................... SKIPPED
[INFO] HBase - Rest ...................................... SKIPPED
[INFO] HBase - Shell ..................................... SKIPPED
[INFO] HBase - Integration Tests ......................... SKIPPED
[INFO] HBase - Examples .................................. SKIPPED
[INFO] HBase - Assembly .................................. SKIPPED
[INFO] HBase - Shaded .................................... SKIPPED
[INFO] HBase - Shaded - Client ........................... SKIPPED
[INFO] HBase - Shaded - Server ........................... SKIPPED
[INFO] ------------------------------------------------------------------------
[INFO] BUILD FAILURE
[INFO] ------------------------------------------------------------------------
[INFO] Total time: 1:43:53.762s
[INFO] Finished at: Wed Jul 22 16:02:09 UTC 2015
[INFO] Final Memory: 95M/735M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.18:test (secondPartTestsExecution) on project hbase-server: ExecutionException: java.lang.RuntimeException: java.lang.RuntimeException: org.apache.maven.surefire.report.ReporterException: When writing xml report stdout/stderr: /tmp/stderr5971057382247780757deferred (No such file or directory) -> [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
[Hadoop] $ /bin/bash -xe /tmp/hudson447682639343933527.sh
++ jps
++ grep surefirebooter
++ wc -l
+ ZOMBIE_TESTS_COUNT=3
+ [[ 3 != 0 ]]
+ echo 'Suspicious java process found - waiting 10s to see if there are just slow to stop'
Suspicious java process found - waiting 10s to see if there are just slow to stop
+ sleep 10
++ jps
++ grep surefirebooter
++ wc -l
+ ZOMBIE_TESTS_COUNT=3
+ [[ 3 != 0 ]]
+ echo 'There are 3 zombie tests, they should have been killed by surefire but survived'
There are 3 zombie tests, they should have been killed by surefire but survived
+ echo '************ BEGIN zombies jstack extract'
************ BEGIN zombies jstack extract
++ jps
++ grep surefirebooter
++ xargs -n 1 jstack
++ cut -d ' ' -f 1
++ grep '\.java'
++ grep .test
9847: Unable to open socket file: target process not responding or HotSpot VM not loaded
The -F option can be used when the target process is not responding
+ ZB_STACK=
POST BUILD TASK : FAILURE
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-1.2 » latest1.7,Hadoop #78
Archived 2113 artifacts
Archive block size is 32768
Received 38 blocks and 520775967 bytes
Compression is 0.2%
Took 2 min 14 sec

Jenkins build is back to normal : HBase-1.2 » latest1.7,Hadoop #81

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-1.2/jdk=latest1.7,label=Hadoop/81/changes>


Build failed in Jenkins: HBase-1.2 » latest1.7,Hadoop #80

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/HBase-1.2/jdk=latest1.7,label=Hadoop/80/changes>

Changes:

[eclark] HBASE-14146 Fix Once replication sees an error it slows down forever

------------------------------------------
[...truncated 55620 lines...]
	at org.apache.hadoop.ipc.Server$Handler.run(Server.java:2007)

"IPC Server handler 0 on 45619" daemon prio=10 tid=0x00007f1648f87000 nid=0x50d2 runnable [0x00007f15d77f6000]
   java.lang.Thread.State: TIMED_WAITING (parking)
	at sun.misc.Unsafe.park(Native Method)
	- parking to wait for  <0x00000000c029af30> (a java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject)
	at java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:196)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.awaitNanos(AbstractQueuedSynchronizer.java:2025)
	at java.util.concurrent.LinkedBlockingQueue.poll(LinkedBlockingQueue.java:424)
	at org.apache.hadoop.ipc.CallQueueManager.take(CallQueueManager.java:109)
	at org.apache.hadoop.ipc.Server$Handler.run(Server.java:2007)

"IPC Server listener on 45619" daemon prio=10 tid=0x00007f16481b3800 nid=0x50d1 runnable [0x00007f15d78f7000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:210)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:65)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:69)
	- locked <0x00000000c09833d8> (a sun.nio.ch.Util$2)
	- locked <0x00000000c09833e8> (a java.util.Collections$UnmodifiableSet)
	- locked <0x00000000c0983390> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:80)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:84)
	at org.apache.hadoop.ipc.Server$Listener.run(Server.java:680)

"IPC Server Responder" daemon prio=10 tid=0x00007f1648f98800 nid=0x50d0 runnable [0x00007f15d7dfc000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:210)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:65)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:69)
	- locked <0x00000000c034cdb8> (a sun.nio.ch.Util$2)
	- locked <0x00000000c034cdc8> (a java.util.Collections$UnmodifiableSet)
	- locked <0x00000000c034cd70> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:80)
	at org.apache.hadoop.ipc.Server$Responder.doRunLoop(Server.java:847)
	at org.apache.hadoop.ipc.Server$Responder.run(Server.java:830)

"org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor@5349249e" daemon prio=10 tid=0x00007f1648c68800 nid=0x50cd waiting on condition [0x00007f15d7bfa000]
   java.lang.Thread.State: WAITING (parking)
	at sun.misc.Unsafe.park(Native Method)
	- parking to wait for  <0x00000000c035fe20> (a java.util.concurrent.locks.ReentrantLock$FairSync)
	at java.util.concurrent.locks.LockSupport.park(LockSupport.java:156)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer.parkAndCheckInterrupt(AbstractQueuedSynchronizer.java:811)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer.acquireQueued(AbstractQueuedSynchronizer.java:842)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer.acquire(AbstractQueuedSynchronizer.java:1178)
	at java.util.concurrent.locks.ReentrantLock$FairSync.lock(ReentrantLock.java:201)
	at java.util.concurrent.locks.ReentrantLock.lock(ReentrantLock.java:262)
	at org.apache.hadoop.hdfs.server.namenode.FSNamesystem.writeLock(FSNamesystem.java:1535)
	at org.apache.hadoop.hdfs.server.blockmanagement.DecommissionManager$Monitor.run(DecommissionManager.java:68)
	at java.lang.Thread.run(Thread.java:662)

"org.apache.hadoop.hdfs.server.blockmanagement.PendingReplicationBlocks$PendingReplicationMonitor@5cef0cdb" daemon prio=10 tid=0x00007f1648f66000 nid=0x50cc waiting on condition [0x00007f15d7cfb000]
   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:662)

"org.apache.hadoop.util.JvmPauseMonitor$Monitor@1c2d5534" daemon prio=10 tid=0x00007f1648add800 nid=0x50c4 waiting for monitor entry [0x00007f15d7efd000]
   java.lang.Thread.State: BLOCKED (on object monitor)
	at org.apache.log4j.Category.callAppenders(Category.java:204)
	- waiting to lock <0x00000000c02057e8> (a org.apache.log4j.spi.RootLogger)
	at org.apache.log4j.Category.forcedLog(Category.java:391)
	at org.apache.log4j.Category.log(Category.java:856)
	at org.apache.commons.logging.impl.Log4JLogger.warn(Log4JLogger.java:222)
	at org.apache.hadoop.util.JvmPauseMonitor$Monitor.run(JvmPauseMonitor.java:189)
	at java.lang.Thread.run(Thread.java:662)

"IPC Server idle connection scanner for port 45619" daemon prio=10 tid=0x00007f164837c800 nid=0x50c3 runnable [0x00007f15d7ffe000]
   java.lang.Thread.State: RUNNABLE
	at java.util.TaskQueue.isEmpty(Timer.java:613)
	at java.util.TimerThread.mainLoop(Timer.java:482)
	- locked <0x00000000c01ef600> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:462)

"pool-1-thread-1" prio=10 tid=0x00007f1648f56800 nid=0x50c1 waiting on condition [0x00007f164428d000]
   java.lang.Thread.State: WAITING (parking)
	at sun.misc.Unsafe.park(Native Method)
	- parking to wait for  <0x00000000c11a3d90> (a java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject)
	at java.util.concurrent.locks.LockSupport.park(LockSupport.java:156)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:1987)
	at java.util.concurrent.DelayQueue.take(DelayQueue.java:160)
	at java.util.concurrent.ScheduledThreadPoolExecutor$DelayedWorkQueue.take(ScheduledThreadPoolExecutor.java:609)
	at java.util.concurrent.ScheduledThreadPoolExecutor$DelayedWorkQueue.take(ScheduledThreadPoolExecutor.java:602)
	at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:957)
	at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:917)
	at java.lang.Thread.run(Thread.java:662)

"Timer-0" daemon prio=10 tid=0x00007f1648ee8000 nid=0x50c0 in Object.wait() [0x00007f164438e000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:509)
	- locked <0x00000000c02abe68> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:462)

"2045721805@qtp-1854861687-1 - Acceptor0 HttpServer2$SelectChannelConnectorWithSafeStartup@localhost:47603" daemon prio=10 tid=0x00007f1648ad5000 nid=0x50bf runnable [0x00007f164448f000]
   java.lang.Thread.State: RUNNABLE
	at sun.nio.ch.EPollArrayWrapper.epollWait(Native Method)
	at sun.nio.ch.EPollArrayWrapper.poll(EPollArrayWrapper.java:210)
	at sun.nio.ch.EPollSelectorImpl.doSelect(EPollSelectorImpl.java:65)
	at sun.nio.ch.SelectorImpl.lockAndDoSelect(SelectorImpl.java:69)
	- locked <0x00000000c02afbb8> (a sun.nio.ch.Util$2)
	- locked <0x00000000c02afbc8> (a java.util.Collections$UnmodifiableSet)
	- locked <0x00000000c02afb70> (a sun.nio.ch.EPollSelectorImpl)
	at sun.nio.ch.SelectorImpl.select(SelectorImpl.java:80)
	at org.mortbay.io.nio.SelectorManager$SelectSet.doSelect(SelectorManager.java:429)
	at org.mortbay.io.nio.SelectorManager.doSelect(SelectorManager.java:185)
	at org.mortbay.jetty.nio.SelectChannelConnector.accept(SelectChannelConnector.java:124)
	at org.mortbay.jetty.AbstractConnector$Acceptor.run(AbstractConnector.java:707)
	at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:582)

"1270440900@qtp-1854861687-0" daemon prio=10 tid=0x00007f1648f0a000 nid=0x50be in Object.wait() [0x00007f1644c7f000]
   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 <0x00000000c034d490> (a org.mortbay.thread.QueuedThreadPool$PoolThread)

"Timer for 'NameNode' metrics system" daemon prio=10 tid=0x00007f1648f0f000 nid=0x50bd in Object.wait() [0x00007f1644b7e000]
   java.lang.Thread.State: TIMED_WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.util.TimerThread.mainLoop(Timer.java:509)
	- locked <0x00000000c02e6e78> (a java.util.TaskQueue)
	at java.util.TimerThread.run(Timer.java:462)

"Low Memory Detector" daemon prio=10 tid=0x00007f16480ca000 nid=0x50b6 runnable [0x0000000000000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread1" daemon prio=10 tid=0x00007f16480c7800 nid=0x50b5 waiting on condition [0x0000000000000000]
   java.lang.Thread.State: RUNNABLE

"C2 CompilerThread0" daemon prio=10 tid=0x00007f16480c5000 nid=0x50b4 waiting on condition [0x0000000000000000]
   java.lang.Thread.State: RUNNABLE

"Signal Dispatcher" daemon prio=10 tid=0x00007f16480c3000 nid=0x50b3 runnable [0x0000000000000000]
   java.lang.Thread.State: RUNNABLE

"Finalizer" daemon prio=10 tid=0x00007f16480a7000 nid=0x50b2 in Object.wait() [0x00007f164ccf0000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:118)
	- locked <0x00000000c0253b60> (a java.lang.ref.ReferenceQueue$Lock)
	at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:134)
	at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:171)

"Reference Handler" daemon prio=10 tid=0x00007f16480a5000 nid=0x50b1 in Object.wait() [0x00007f164cdf1000]
   java.lang.Thread.State: WAITING (on object monitor)
	at java.lang.Object.wait(Native Method)
	at java.lang.Object.wait(Object.java:485)
	at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:116)
	- locked <0x00000000c0253b20> (a java.lang.ref.Reference$Lock)

"main" prio=10 tid=0x00007f1648008000 nid=0x50a2 waiting on condition [0x00007f164fe5e000]
   java.lang.Thread.State: WAITING (parking)
	at sun.misc.Unsafe.park(Native Method)
	- parking to wait for  <0x00000000d5f09878> (a java.util.concurrent.Semaphore$NonfairSync)
	at java.util.concurrent.locks.LockSupport.park(LockSupport.java:156)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer.parkAndCheckInterrupt(AbstractQueuedSynchronizer.java:811)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer.doAcquireSharedInterruptibly(AbstractQueuedSynchronizer.java:969)
	at java.util.concurrent.locks.AbstractQueuedSynchronizer.acquireSharedInterruptibly(AbstractQueuedSynchronizer.java:1281)
	at java.util.concurrent.Semaphore.acquire(Semaphore.java:286)
	at org.apache.tajo.rpc.BlockingRpcClient$ProtoCallFuture.get(BlockingRpcClient.java:170)
	at org.apache.tajo.rpc.BlockingRpcClient$ProxyRpcChannel.callBlockingMethod(BlockingRpcClient.java:97)
	at org.apache.tajo.ipc.TajoMasterClientProtocol$TajoMasterClientProtocolService$BlockingStub.getQueryStatus(TajoMasterClientProtocol.java:2043)
	at org.apache.tajo.client.QueryClientImpl.getQueryStatus(QueryClientImpl.java:293)
	at org.apache.tajo.client.TajoClientUtil.waitCompletion(TajoClientUtil.java:73)
	at org.apache.tajo.client.QueryClientImpl.getQueryResultAndWait(QueryClientImpl.java:261)
	at org.apache.tajo.client.QueryClientImpl.executeQueryAndGetResult(QueryClientImpl.java:208)
	at org.apache.tajo.client.TajoClientImpl.executeQueryAndGetResult(TajoClientImpl.java:110)
	at org.apache.tajo.QueryTestCaseBase.runSimpleTests(QueryTestCaseBase.java:522)
	at org.apache.tajo.engine.query.TestInnerJoinWithSubQuery.testComplexJoinCondition7(TestInnerJoinWithSubQuery.java:109)
	at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
	at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
	at java.lang.reflect.Method.invoke(Method.java:597)
	at org.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java: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.rules.TestWatcher$1.evaluate(TestWatcher.java:55)
	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.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.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.apache.maven.surefire.junit4.JUnit4Provider.execute(JUnit4Provider.java:264)
	at org.apache.maven.surefire.junit4.JUnit4Provider.executeTestSet(JUnit4Provider.java:153)
	at org.apache.maven.surefire.junit4.JUnit4Provider.invoke(JUnit4Provider.java:124)
	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=0x00007f164809e000 nid=0x50b0 runnable 

"GC task thread#0 (ParallelGC)" prio=10 tid=0x00007f164801b000 nid=0x50a3 runnable 

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

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

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

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

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

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

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

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

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

"GC task thread#10 (ParallelGC)" prio=10 tid=0x00007f164802d000 nid=0x50ad runnable 

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

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

"VM Periodic Task Thread" prio=10 tid=0x00007f16480d4800 nid=0x50b7 waiting on condition 

JNI global references: 1501

POST BUILD TASK : FAILURE
END OF POST BUILD TASK : 0
Archiving artifacts
Sending artifact delta relative to HBase-1.2 » latest1.7,Hadoop #78
Archived 2113 artifacts
Archive block size is 32768
Received 38 blocks and 511649997 bytes
Compression is 0.2%
Took 2 min 19 sec