See <https://builds.apache.org/job/Tajo-master-nightly/424/changes>
Changes:
[jinossy] TAJO-989: Cleanup of child blocks after parent execution block is
complete. (jinho)
[jinossy] TAJO-949: PullServer does not release files, when a channel throws an
internal exception. (jinho)
------------------------------------------
[...truncated 1215 lines...]
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.052 sec
Running org.apache.tajo.storage.TestLazyTuple
Tests run: 8, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.006 sec
Running org.apache.tajo.storage.v2.TestStorages
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: Flushing mem store to file. allocated memory: 51,131,316
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 34B for [col1] BOOLEAN: 1 values, 7B raw, 7B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 43B for [col2] INT32: 1 values, 10B raw, 10B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 56B for [col3] BINARY: 1 values, 17B raw, 17B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 43B for [col4] INT32: 1 values, 10B raw, 10B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 43B for [col5] INT32: 1 values, 10B raw, 10B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 55B for [col6] INT64: 1 values, 14B raw, 14B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 43B for [col7] FLOAT: 1 values, 10B raw, 10B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 55B for [col8] DOUBLE: 1 values, 14B raw, 14B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 56B for [col9] BINARY: 1 values, 17B raw, 17B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 56B for [col10] BINARY: 1 values, 17B raw, 17B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 47B for [col11] BINARY: 1 values, 14B raw, 14B comp, 1 pages,
encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: RecordReader initialized will read a total of 1 records.
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: at row 0. reading next block
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: block read in memory in 1 ms. row count = 1
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: Flushing mem store to file. allocated memory: 34,044,142
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 40,047B for [id] INT32: 10,000 values, 40,008B raw, 40,008B comp,
1 pages, encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 80,055B for [age] INT64: 10,000 values, 80,008B raw, 80,008B
comp, 1 pages, encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: written 40,047B for [score] FLOAT: 10,000 values, 40,008B raw, 40,008B
comp, 1 pages, encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: RecordReader initialized will read a total of 10000 records.
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: at row 0. reading next block
Aug 6, 2014 3:22:35 AM parquet.Log info
INFO: block read in memory in 1 ms. row count = 10000
Tests run: 18, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.387 sec
Running org.apache.tajo.storage.v2.TestCSVScanner
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.782 sec
Running org.apache.tajo.storage.v2.TestCSVCompression
Tests run: 5, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.216 sec
Running org.apache.tajo.storage.index.TestSingleCSVFileBSTIndex
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.91 sec
Running org.apache.tajo.storage.index.TestBSTIndex
Tests run: 20, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 16.11 sec
Running org.apache.tajo.storage.TestFileSystems
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.018 sec
Running org.apache.tajo.storage.TestStorageManager
Formatting using clusterid: testClusterID
Formatting using clusterid: testClusterID
Tests run: 3, Failures: 0, Errors: 2, Skipped: 0, Time elapsed: 2.208 sec <<<
FAILURE!
testGetSplit(org.apache.tajo.storage.TestStorageManager) Time elapsed: 1.662
sec <<< ERROR!
java.net.UnknownHostException: asf901.ygridcore.net: asf901.ygridcore.net
at java.net.InetAddress.getLocalHost(InetAddress.java:1402)
at
org.apache.hadoop.security.SecurityUtil.getLocalHostName(SecurityUtil.java:186)
at org.apache.hadoop.security.SecurityUtil.login(SecurityUtil.java:206)
at
org.apache.hadoop.hdfs.server.datanode.DataNode.instantiateDataNode(DataNode.java:1746)
at
org.apache.hadoop.hdfs.MiniDFSCluster.startDataNodes(MiniDFSCluster.java:1218)
at
org.apache.hadoop.hdfs.MiniDFSCluster.initMiniDFSCluster(MiniDFSCluster.java:684)
at org.apache.hadoop.hdfs.MiniDFSCluster.<init>(MiniDFSCluster.java:351)
at
org.apache.hadoop.hdfs.MiniDFSCluster$Builder.build(MiniDFSCluster.java:332)
at
org.apache.tajo.storage.TestStorageManager.testGetSplit(TestStorageManager.java:110)
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.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.runners.ParentRunner.run(ParentRunner.java:309)
at
org.apache.maven.surefire.junit4.JUnit4Provider.execute(JUnit4Provider.java:252)
at
org.apache.maven.surefire.junit4.JUnit4Provider.executeTestSet(JUnit4Provider.java:141)
at
org.apache.maven.surefire.junit4.JUnit4Provider.invoke(JUnit4Provider.java:112)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
at java.lang.reflect.Method.invoke(Method.java:597)
at
org.apache.maven.surefire.util.ReflectionUtils.invokeMethodWithArray(ReflectionUtils.java:189)
at
org.apache.maven.surefire.booter.ProviderFactory$ProviderProxy.invoke(ProviderFactory.java:165)
at
org.apache.maven.surefire.booter.ProviderFactory.invokeProvider(ProviderFactory.java:85)
at
org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:115)
at
org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:75)
testGetSplitWithBlockStorageLocationsBatching(org.apache.tajo.storage.TestStorageManager)
Time elapsed: 0.494 sec <<< ERROR!
java.net.UnknownHostException: asf901.ygridcore.net: asf901.ygridcore.net
at java.net.InetAddress.getLocalHost(InetAddress.java:1402)
at
org.apache.hadoop.security.SecurityUtil.getLocalHostName(SecurityUtil.java:186)
at org.apache.hadoop.security.SecurityUtil.login(SecurityUtil.java:206)
at
org.apache.hadoop.hdfs.server.datanode.DataNode.instantiateDataNode(DataNode.java:1746)
at
org.apache.hadoop.hdfs.MiniDFSCluster.startDataNodes(MiniDFSCluster.java:1218)
at
org.apache.hadoop.hdfs.MiniDFSCluster.initMiniDFSCluster(MiniDFSCluster.java:684)
at org.apache.hadoop.hdfs.MiniDFSCluster.<init>(MiniDFSCluster.java:351)
at
org.apache.hadoop.hdfs.MiniDFSCluster$Builder.build(MiniDFSCluster.java:332)
at
org.apache.tajo.storage.TestStorageManager.testGetSplitWithBlockStorageLocationsBatching(TestStorageManager.java:165)
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.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.runners.ParentRunner.run(ParentRunner.java:309)
at
org.apache.maven.surefire.junit4.JUnit4Provider.execute(JUnit4Provider.java:252)
at
org.apache.maven.surefire.junit4.JUnit4Provider.executeTestSet(JUnit4Provider.java:141)
at
org.apache.maven.surefire.junit4.JUnit4Provider.invoke(JUnit4Provider.java:112)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
at java.lang.reflect.Method.invoke(Method.java:597)
at
org.apache.maven.surefire.util.ReflectionUtils.invokeMethodWithArray(ReflectionUtils.java:189)
at
org.apache.maven.surefire.booter.ProviderFactory$ProviderProxy.invoke(ProviderFactory.java:165)
at
org.apache.maven.surefire.booter.ProviderFactory.invokeProvider(ProviderFactory.java:85)
at
org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:115)
at
org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:75)
Running org.apache.tajo.storage.TestFrameTuple
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0 sec
Running org.apache.tajo.storage.TestVTuple
Tests run: 6, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.002 sec
Running org.apache.tajo.storage.TestTupleComparator
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0 sec
Running org.apache.tajo.storage.TestMergeScanner
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: Flushing mem store to file. allocated memory: 36,271,037
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: written 40,047B for [id] INT32: 10,000 values, 40,008B raw, 40,008B comp,
1 pages, encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: written 53B for [file] BINARY: 10,000 values, 12B raw, 12B comp, 1 pages,
encodings: [BIT_PACKED, PLAIN_DICTIONARY, RLE], dic { 1 entries, 11B raw, 1B
comp}
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: written 51B for [name] BINARY: 10,000 values, 12B raw, 12B comp, 1 pages,
encodings: [BIT_PACKED, PLAIN_DICTIONARY, RLE], dic { 1 entries, 10B raw, 1B
comp}
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: written 55B for [age] INT64: 10,000 values, 12B raw, 12B comp, 1 pages,
encodings: [BIT_PACKED, PLAIN_DICTIONARY, RLE], dic { 1 entries, 8B raw, 1B
comp}
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: Flushing mem store to file. allocated memory: 36,271,037
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: written 40,047B for [id] INT32: 10,000 values, 40,008B raw, 40,008B comp,
1 pages, encodings: [BIT_PACKED, RLE, PLAIN]
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: written 53B for [file] BINARY: 10,000 values, 12B raw, 12B comp, 1 pages,
encodings: [BIT_PACKED, PLAIN_DICTIONARY, RLE], dic { 1 entries, 11B raw, 1B
comp}
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: written 51B for [name] BINARY: 10,000 values, 12B raw, 12B comp, 1 pages,
encodings: [BIT_PACKED, PLAIN_DICTIONARY, RLE], dic { 1 entries, 10B raw, 1B
comp}
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: written 55B for [age] INT64: 10,000 values, 12B raw, 12B comp, 1 pages,
encodings: [BIT_PACKED, PLAIN_DICTIONARY, RLE], dic { 1 entries, 8B raw, 1B
comp}
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: RecordReader initialized will read a total of 10000 records.
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: at row 0. reading next block
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: block read in memory in 1 ms. row count = 10000
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: RecordReader initialized will read a total of 10000 records.
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: at row 0. reading next block
Aug 6, 2014 3:23:00 AM parquet.Log info
INFO: block read in memory in 1 ms. row count = 10000
Tests run: 7, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.831 sec
Aug 6, 2014 3:22:27 AM INFO: parquet.hadoop.ParquetFileReader: reading another
1 footers
Aug 6, 2014 3:22:27 AM INFO: parquet.hadoop.ParquetFileReader: reading another
1 footers
Aug 6, 2014 3:22:28 AM INFO: parquet.hadoop.ParquetFileReader: reading another
1 footers
Aug 6, 2014 3:22:34 AM INFO: parquet.hadoop.ParquetFileReader: reading another
1 footers
Aug 6, 2014 3:22:35 AM INFO: parquet.hadoop.ParquetFileReader: reading another
1 footers
Aug 6, 2014 3:22:35 AM INFO: parquet.hadoop.ParquetFileReader: reading another
1 footers
Aug 6, 2014 3:23:00 AM INFO: parquet.hadoop.ParquetFileReader: reading another
1 footers
Aug 6, 2014 3:23:00 AM INFO: parquet.hadoop.ParquetFileReader: reading another
1 footers
Results :
Tests in error:
testGetSplit(org.apache.tajo.storage.TestStorageManager):
asf901.ygridcore.net: asf901.ygridcore.net
testGetSplitWithBlockStorageLocationsBatching(org.apache.tajo.storage.TestStorageManager):
asf901.ygridcore.net: asf901.ygridcore.net
Tests run: 155, Failures: 0, Errors: 2, Skipped: 0
[INFO] ------------------------------------------------------------------------
[INFO] Reactor Summary:
[INFO]
[INFO] Tajo Main ......................................... SUCCESS [ 12.245 s]
[INFO] Tajo Project POM .................................. SUCCESS [ 0.775 s]
[INFO] Tajo Maven Plugins ................................ SUCCESS [ 2.941 s]
[INFO] Tajo Common ....................................... SUCCESS [ 39.749 s]
[INFO] Tajo Algebra ...................................... SUCCESS [ 1.337 s]
[INFO] Tajo Catalog Common ............................... SUCCESS [ 5.191 s]
[INFO] Tajo Rpc .......................................... SUCCESS [ 21.250 s]
[INFO] Tajo Catalog Client ............................... SUCCESS [ 1.043 s]
[INFO] Tajo Catalog Server ............................... SUCCESS [ 5.629 s]
[INFO] Tajo Storage ...................................... FAILURE [ 40.537 s]
[INFO] Tajo Core PullServer .............................. SKIPPED
[INFO] Tajo Client ....................................... SKIPPED
[INFO] Tajo JDBC Driver .................................. SKIPPED
[INFO] Tajo Catalog Drivers HCatalog ..................... SKIPPED
[INFO] Tajo Core ......................................... SKIPPED
[INFO] Tajo Catalog Drivers .............................. SKIPPED
[INFO] Tajo Catalog ...................................... SKIPPED
[INFO] Tajo Distribution ................................. SKIPPED
[INFO] ------------------------------------------------------------------------
[INFO] BUILD FAILURE
[INFO] ------------------------------------------------------------------------
[INFO] Total time: 02:11 min
[INFO] Finished at: 2014-08-06T03:23:01+00:00
[INFO] Final Memory: 60M/715M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal
org.apache.maven.plugins:maven-surefire-plugin:2.12.4:test (default-test) on
project tajo-storage: There are test failures.
[ERROR]
[ERROR] Please refer to
<https://builds.apache.org/job/Tajo-master-nightly/ws/tajo-storage/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 :tajo-storage
Build step 'Execute shell' marked build as failure
Recording test results