You are viewing a plain text version of this content. The canonical link for it is here.
Posted to commits@carbondata.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2017/09/14 17:04:04 UTC
Build failed in Jenkins: carbondata-master-spark-2.1 » Apache CarbonData :: presto #1379
See <https://builds.apache.org/job/carbondata-master-spark-2.1/org.apache.carbondata$carbondata-presto/1379/display/redirect?page=changes>
Changes:
[chenliang613] [SDV]Disable tests in other modules except cluster
------------------------------------------
[...truncated 172.85 KB...]
INFO: TIMELINE: Query 20170914_170316_00005_dk7pr :: Transaction:[57503fce-181b-4bba-b028-c19c04ec28fe] :: elapsed 227ms :: planning 43ms :: scheduling 184ms :: running 0ms :: finishing 184ms :: begin 2017-09-14T17:03:16.820Z :: end 2017-09-14T17:03:17.047Z
2017-09-14 17:03:17 INFO PrestoServer$:101 - ***** executing the query *****
SELECT COUNT(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
[31m- test the result for max() with distinct operator in presto *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:89)[0m
Sep 14, 2017 5:03:17 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170317_00006_dk7pr :: Transaction:[5d5302eb-3fca-4894-9961-a788f965008e] :: elapsed 200ms :: planning 60ms :: scheduling 140ms :: running 0ms :: finishing 140ms :: begin 2017-09-14T17:03:17.078Z :: end 2017-09-14T17:03:17.278Z
[32m- test the result for count()clause with distinct operator on decimal column in presto[0m
2017-09-14 17:03:17 INFO PrestoServer$:101 - ***** executing the query *****
SELECT COUNT(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 14, 2017 5:03:17 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170317_00007_dk7pr :: Transaction:[22bfa85b-8e31-438f-93a3-26e91c49f66a] :: elapsed 182ms :: planning 42ms :: scheduling 140ms :: running 0ms :: finishing 140ms :: begin 2017-09-14T17:03:17.292Z :: end 2017-09-14T17:03:17.474Z
[32m- test the result for count()clause with out distinct operator on decimal column in presto[0m
Sep 14, 2017 5:03:17 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170317_00008_dk7pr :: Transaction:[f57aac35-8969-46cc-9417-31b26fef55d8] :: elapsed 55ms :: planning 26ms :: scheduling 29ms :: running 0ms :: finishing 29ms :: begin 2017-09-14T17:03:17.494Z :: end 2017-09-14T17:03:17.549Z
2017-09-14 17:03:17 INFO PrestoServer$:101 - ***** executing the query *****
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for sum()with out distinct operator for decimal column in presto[0m
2017-09-14 17:03:17 INFO PrestoServer$:101 - ***** executing the query *****
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 14, 2017 5:03:17 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170317_00009_dk7pr :: Transaction:[2383d39e-1cb6-4fc0-8266-a850e595b80e] :: elapsed 152ms :: planning 38ms :: scheduling 114ms :: running 0ms :: finishing 114ms :: begin 2017-09-14T17:03:17.561Z :: end 2017-09-14T17:03:17.713Z
2017-09-14 17:03:17 INFO PrestoServer$:101 - ***** executing the query *****
SELECT AVG(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 14, 2017 5:03:17 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170317_00010_dk7pr :: Transaction:[00c1a3fe-927d-4ec3-abd8-66b7791ef5c6] :: elapsed 167ms :: planning 35ms :: scheduling 132ms :: running 0ms :: finishing 132ms :: begin 2017-09-14T17:03:17.728Z :: end 2017-09-14T17:03:17.895Z
[31m- test the result for sum() with distinct operator for decimal column in presto *** FAILED ***[0m
[31m java.lang.NullPointerException:[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply$mcV$sp(PrestoAllDataTypeTest.scala:115)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m at org.scalatest.FunSuiteLike$$anon$1.apply(FunSuiteLike.scala:166)[0m
[31m at org.scalatest.Suite$class.withFixture(Suite.scala:1122)[0m
[31m ...[0m
[32m- test the result for avg() with distinct operator on decimal coin presto[0m
2017-09-14 17:03:18 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MIN(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 14, 2017 5:03:18 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170317_00011_dk7pr :: Transaction:[6517aa23-9838-4f9c-9216-486b38a0a843] :: elapsed 155ms :: planning 55ms :: scheduling 100ms :: running 0ms :: finishing 100ms :: begin 2017-09-14T17:03:17.912Z :: end 2017-09-14T17:03:18.067Z
[32m- test the result for min() with distinct operator in decimalType of presto[0m
Sep 14, 2017 5:03:18 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170318_00012_dk7pr :: Transaction:[d41556e5-1ef2-41a9-83d0-4ecf24eebcb7] :: elapsed 96ms :: planning 46ms :: scheduling 50ms :: running 0ms :: finishing 50ms :: begin 2017-09-14T17:03:18.081Z :: end 2017-09-14T17:03:18.177Z
2017-09-14 17:03:18 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MAX(BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for max() with distinct operator in decimalType of presto[0m
2017-09-14 17:03:18 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT BONUS FROM TESTDB.TESTTABLE ORDER BY BONUS limit 3
Sep 14, 2017 5:03:18 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170318_00013_dk7pr :: Transaction:[e321b7ac-9d58-45a3-9e23-4cd159203764] :: elapsed 81ms :: planning 43ms :: scheduling 38ms :: running 0ms :: finishing 38ms :: begin 2017-09-14T17:03:18.190Z :: end 2017-09-14T17:03:18.271Z
[31m- select decimal data type with ORDER BY clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:147)[0m
2017-09-14 17:03:18 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE ORDER BY NAME
Sep 14, 2017 5:03:18 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170318_00014_dk7pr :: Transaction:[e3da5cd4-518a-4058-bf03-e3e9da912aee] :: elapsed 117ms :: planning 29ms :: scheduling 88ms :: running 0ms :: finishing 88ms :: begin 2017-09-14T17:03:18.294Z :: end 2017-09-14T17:03:18.411Z
2017-09-14 17:03:18 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DATE FROM TESTDB.TESTTABLE ORDER BY DATE
[31m- select string type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:162)[0m
Sep 14, 2017 5:03:18 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170318_00015_dk7pr :: Transaction:[4fe74353-ba1a-4dbc-ac6f-229dfb6c2b24] :: elapsed 68ms :: planning 22ms :: scheduling 46ms :: running 0ms :: finishing 46ms :: begin 2017-09-14T17:03:18.431Z :: end 2017-09-14T17:03:18.499Z
Sep 14, 2017 5:03:18 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170318_00016_dk7pr :: Transaction:[0546ac44-8da6-44fb-a1bf-99a4444fe1a1] :: elapsed 41ms :: planning 22ms :: scheduling 19ms :: running 0ms :: finishing 19ms :: begin 2017-09-14T17:03:18.517Z :: end 2017-09-14T17:03:18.558Z
2017-09-14 17:03:18 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT ID FROM TESTDB.TESTTABLE ORDER BY ID
[31m- select DATE type with order by clause *** FAILED ***[0m
[31m java.util.NoSuchElementException: head of empty list[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:420)[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:417)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply$mcV$sp(PrestoAllDataTypeTest.scala:182)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m ...[0m
2017-09-14 17:03:18 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID>2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- select int type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:197)[0m
Sep 14, 2017 5:03:18 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170318_00017_dk7pr :: Transaction:[c43e5298-189d-4835-a157-5c2557122a98] :: elapsed 71ms :: planning 24ms :: scheduling 47ms :: running 0ms :: finishing 47ms :: begin 2017-09-14T17:03:18.571Z :: end 2017-09-14T17:03:18.642Z
2017-09-14 17:03:18 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test and filter clause with greater than expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:223)[0m
Sep 14, 2017 5:03:18 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170318_00018_dk7pr :: Transaction:[a63f3b30-a93b-476f-a530-6be60706817a] :: elapsed 276ms :: planning 149ms :: scheduling 127ms :: running 0ms :: finishing 127ms :: begin 2017-09-14T17:03:18.681Z :: end 2017-09-14T17:03:18.957Z
[31m- test and filter clause with greater than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:267)[0m
2017-09-14 17:03:19 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS<=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID LIMIT 2
Sep 14, 2017 5:03:19 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170318_00019_dk7pr :: Transaction:[94a3dab1-40b2-4d51-81ee-c0a56a1037f5] :: elapsed 143ms :: planning 64ms :: scheduling 79ms :: running 0ms :: finishing 79ms :: begin 2017-09-14T17:03:18.984Z :: end 2017-09-14T17:03:19.127Z
2017-09-14 17:03:19 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE BONUS=1234.444
[31m- test and filter clause with less than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:292)[0m
Sep 14, 2017 5:03:19 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170319_00020_dk7pr :: Transaction:[c70cebc3-e05b-448b-915e-69f758c8ef13] :: elapsed 158ms :: planning 84ms :: scheduling 74ms :: running 0ms :: finishing 74ms :: begin 2017-09-14T17:03:19.147Z :: end 2017-09-14T17:03:19.305Z
Sep 14, 2017 5:03:19 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170319_00021_dk7pr :: Transaction:[1d5d4d22-d9f5-493f-a053-c7498847afaf] :: elapsed 109ms :: planning 74ms :: scheduling 35ms :: running 0ms :: finishing 35ms :: begin 2017-09-14T17:03:19.327Z :: end 2017-09-14T17:03:19.436Z
2017-09-14 17:03:19 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID<2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test equal to expression on decimal value *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:301)[0m
2017-09-14 17:03:19 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE IN('phone1848','phone706')
[31m- test less than expression with and operator *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:317)[0m
Sep 14, 2017 5:03:19 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170319_00022_dk7pr :: Transaction:[723c2328-1662-4936-9bdc-089a33220f24] :: elapsed 312ms :: planning 102ms :: scheduling 210ms :: running 0ms :: finishing 210ms :: begin 2017-09-14T17:03:19.454Z :: end 2017-09-14T17:03:19.766Z
2017-09-14 17:03:20 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE NOT IN('phone1848','phone706')
[31m- test the result for in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:327)[0m
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170319_00023_dk7pr :: Transaction:[4598db10-bdf6-45f7-bafc-f3e02323b6be] :: elapsed 348ms :: planning 327ms :: scheduling 21ms :: running 0ms :: finishing 21ms :: begin 2017-09-14T17:03:19.789Z :: end 2017-09-14T17:03:20.137Z
2017-09-14 17:03:20 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE DATE IS NULL
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170320_00024_dk7pr :: Transaction:[37aa284d-019c-410e-b26e-74e2542468f2] :: elapsed 51ms :: planning 35ms :: scheduling 16ms :: running 0ms :: finishing 16ms :: begin 2017-09-14T17:03:20.152Z :: end 2017-09-14T17:03:20.203Z
[31m- test the result for not in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:341)[0m
2017-09-14 17:03:20 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DATE IS NOT NULL AND ID=9
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170320_00025_dk7pr :: Transaction:[3d7845ce-18ba-4052-bac2-2600459c4d07] :: elapsed 39ms :: planning 24ms :: scheduling 15ms :: running 0ms :: finishing 15ms :: begin 2017-09-14T17:03:20.221Z :: end 2017-09-14T17:03:20.260Z
[31m- test for null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:347)[0m
[31m- test for not null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:354)[0m
2017-09-14 17:03:20 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NOT NULL AND ID=9
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170320_00026_dk7pr :: Transaction:[d1062746-9b37-4771-9111-65fda3a37a0b] :: elapsed 76ms :: planning 35ms :: scheduling 41ms :: running 0ms :: finishing 41ms :: begin 2017-09-14T17:03:20.271Z :: end 2017-09-14T17:03:20.347Z
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170320_00027_dk7pr :: Transaction:[2346b446-6c96-4114-9c53-3eafca3e31c9] :: elapsed 49ms :: planning 33ms :: scheduling 16ms :: running 0ms :: finishing 16ms :: begin 2017-09-14T17:03:20.359Z :: end 2017-09-14T17:03:20.408Z
2017-09-14 17:03:20 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NULL AND ID=1
[31m- test for not null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:362)[0m
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170320_00028_dk7pr :: Transaction:[0dccfa87-cda5-4ae6-b855-61056e099bcd] :: elapsed 63ms :: planning 47ms :: scheduling 16ms :: running 0ms :: finishing 16ms :: begin 2017-09-14T17:03:20.428Z :: end 2017-09-14T17:03:20.491Z
[31m- test for null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:369)[0m
2017-09-14 17:03:20 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT SHORTFIELD from testdb.testtable ORDER BY SHORTFIELD
2017-09-14 17:03:20 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD IS NULL ORDER BY SHORTFIELD
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170320_00029_dk7pr :: Transaction:[34f9977d-1bf8-4f0a-aa90-cbba51a0d4fe] :: elapsed 91ms :: planning 31ms :: scheduling 60ms :: running 0ms :: finishing 60ms :: begin 2017-09-14T17:03:20.505Z :: end 2017-09-14T17:03:20.596Z
[31m- test the result for short datatype with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:385)[0m
[31m- test the result for short datatype in clause where field is null *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:393)[0m
2017-09-14 17:03:20 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD>11
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170320_00030_dk7pr :: Transaction:[4d6d7e00-b6f4-4cea-87ee-200b7b47a0ca] :: elapsed 105ms :: planning 83ms :: scheduling 22ms :: running 0ms :: finishing 22ms :: begin 2017-09-14T17:03:20.611Z :: end 2017-09-14T17:03:20.716Z
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170914_170320_00031_dk7pr :: Transaction:[4a8dad7e-e60c-4477-8dc1-68781bc5b50b] :: elapsed 38ms :: planning 26ms :: scheduling 12ms :: running 0ms :: finishing 12ms :: begin 2017-09-14T17:03:20.726Z :: end 2017-09-14T17:03:20.764Z
[31m- test the result for short datatype with greater than operator *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:401)[0m
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 14, 2017 5:03:20 PM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4ef277ef{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:8086}
Sep 14, 2017 5:03:20 PM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@2c51c756{/,null,UNAVAILABLE,@http}
Sep 14, 2017 5:03:20 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=15<=200,i=9,q=9} Couldn't stop Thread[http-worker-214,5,main]
Sep 14, 2017 5:03:20 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=15<=200,i=0,q=8} Couldn't stop Thread[http-worker-384,5,]
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 14, 2017 5:03:20 PM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 14, 2017 5:03:20 PM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@31c0c7e5{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:36498}
2017-09-14 17:03:21 INFO AbstractDataLoadProcessorStep:150 - Thread-2 Rows processed in step Data Writer : 10
2017-09-14 17:03:21 INFO AbstractDataLoadProcessorStep:150 - Thread-3 Rows processed in step Data Converter : 10
2017-09-14 17:03:21 INFO AbstractDataLoadProcessorStep:150 - Thread-4 Rows processed in step Input Processor : 10
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@67f266bd{/,null,UNAVAILABLE,@http}
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=12<=200,i=2,q=5} Couldn't stop Thread[http-worker-307,5,]
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=12<=200,i=0,q=3} Couldn't stop Thread[http-worker-247,5,]
Sep 14, 2017 5:03:24 PM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 14, 2017 5:03:24 PM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4adcc981{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:35159}
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@729d6ee2{/,null,UNAVAILABLE,@http}
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=12,q=12} Couldn't stop Thread[http-worker-278,5,main]
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=7,q=11} Couldn't stop Thread[http-worker-118,5,]
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=5,q=10} Couldn't stop Thread[http-worker-250,5,]
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=0,q=9} Couldn't stop Thread[http-worker-387,5,]
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=0,q=9} Couldn't stop Thread[http-worker-410,5,]
Sep 14, 2017 5:03:24 PM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 14, 2017 5:03:24 PM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@38929da{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:43532}
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@1e6d30c0{/,null,UNAVAILABLE,@http}
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=13,q=13} Couldn't stop Thread[http-worker-86,5,main]
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=6,q=12} Couldn't stop Thread[http-worker-361,5,]
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=0,q=12} Couldn't stop Thread[http-worker-413,5,]
Sep 14, 2017 5:03:24 PM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 14, 2017 5:03:24 PM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@7da635c0{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:36831}
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@3d615b2e{/,null,UNAVAILABLE,@http}
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=9,q=9} Couldn't stop Thread[http-worker-418,5,main]
Sep 14, 2017 5:03:24 PM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=0,q=6} Couldn't stop Thread[http-worker-45,5,]
Sep 14, 2017 5:03:24 PM io.airlift.log.Logger info
INFO: Life cycle stopped.
2017-09-14 17:03:24 INFO PrestoServer$:88 - ***** Stopping The Server *****
[36mRun completed in 24 seconds, 343 milliseconds.[0m
[36mTotal number of tests run: 32[0m
[36mSuites: completed 2, aborted 0[0m
[36mTests: succeeded 6, failed 26, canceled 0, ignored 0, pending 0[0m
[31m*** 26 TESTS FAILED ***[0m
[JENKINS] Recording test results
Jenkins build is back to normal : carbondata-master-spark-2.1 » Apache CarbonData :: presto #1386
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/carbondata-master-spark-2.1/org.apache.carbondata$carbondata-presto/1386/display/redirect?page=changes>
Build failed in Jenkins: carbondata-master-spark-2.1 » Apache CarbonData :: presto #1385
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/carbondata-master-spark-2.1/org.apache.carbondata$carbondata-presto/1385/display/redirect>
------------------------------------------
[...truncated 174.40 KB...]
2017-09-15 09:50:01 INFO PrestoServer$:101 - ***** executing the query *****
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 9:50:01 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095001_00009_hq8e7 :: Transaction:[58a0b043-7da2-4149-aa6a-01a58484d446] :: elapsed 263ms :: planning 52ms :: scheduling 211ms :: running 0ms :: finishing 211ms :: begin 2017-09-15T09:50:01.367Z :: end 2017-09-15T09:50:01.630Z
2017-09-15 09:50:01 INFO PrestoServer$:101 - ***** executing the query *****
SELECT AVG(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 9:50:01 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095001_00010_hq8e7 :: Transaction:[b8314270-610f-4f05-8bd2-6ab417f2383d] :: elapsed 171ms :: planning 33ms :: scheduling 138ms :: running 0ms :: finishing 138ms :: begin 2017-09-15T09:50:01.655Z :: end 2017-09-15T09:50:01.826Z
[31m- test the result for sum() with distinct operator for decimal column in presto *** FAILED ***[0m
[31m java.lang.NullPointerException:[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply$mcV$sp(PrestoAllDataTypeTest.scala:115)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m at org.scalatest.FunSuiteLike$$anon$1.apply(FunSuiteLike.scala:166)[0m
[31m at org.scalatest.Suite$class.withFixture(Suite.scala:1122)[0m
[31m ...[0m
Sep 15, 2017 9:50:02 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095001_00011_hq8e7 :: Transaction:[13652ef9-c0d9-4dd0-92cc-0c7ff76a72e9] :: elapsed 171ms :: planning 45ms :: scheduling 126ms :: running 0ms :: finishing 126ms :: begin 2017-09-15T09:50:01.844Z :: end 2017-09-15T09:50:02.015Z
2017-09-15 09:50:02 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MIN(BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for avg() with distinct operator on decimal coin presto[0m
Sep 15, 2017 9:50:02 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095002_00012_hq8e7 :: Transaction:[18d7e1d1-5efa-491e-bd1f-68a2f8758890] :: elapsed 93ms :: planning 47ms :: scheduling 46ms :: running 0ms :: finishing 46ms :: begin 2017-09-15T09:50:02.037Z :: end 2017-09-15T09:50:02.130Z
[32m- test the result for min() with distinct operator in decimalType of presto[0m
2017-09-15 09:50:02 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MAX(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 9:50:02 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095002_00013_hq8e7 :: Transaction:[e4f64e44-3ec3-4787-9522-1debda83443f] :: elapsed 95ms :: planning 49ms :: scheduling 46ms :: running 0ms :: finishing 46ms :: begin 2017-09-15T09:50:02.143Z :: end 2017-09-15T09:50:02.238Z
[32m- test the result for max() with distinct operator in decimalType of presto[0m
2017-09-15 09:50:02 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT BONUS FROM TESTDB.TESTTABLE ORDER BY BONUS limit 3
2017-09-15 09:50:02 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE ORDER BY NAME
[31m- select decimal data type with ORDER BY clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:147)[0m
Sep 15, 2017 9:50:02 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095002_00014_hq8e7 :: Transaction:[1bc9d592-b439-4b93-ba3b-c6a31f235278] :: elapsed 174ms :: planning 30ms :: scheduling 144ms :: running 0ms :: finishing 144ms :: begin 2017-09-15T09:50:02.267Z :: end 2017-09-15T09:50:02.441Z
2017-09-15 09:50:02 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DATE FROM TESTDB.TESTTABLE ORDER BY DATE
[31m- select string type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:162)[0m
Sep 15, 2017 9:50:02 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095002_00015_hq8e7 :: Transaction:[f8b291f2-dc18-4c2c-ba4b-65e7de979070] :: elapsed 96ms :: planning 32ms :: scheduling 64ms :: running 0ms :: finishing 64ms :: begin 2017-09-15T09:50:02.456Z :: end 2017-09-15T09:50:02.552Z
2017-09-15 09:50:02 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT ID FROM TESTDB.TESTTABLE ORDER BY ID
[31m- select DATE type with order by clause *** FAILED ***[0m
[31m java.util.NoSuchElementException: head of empty list[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:420)[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:417)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply$mcV$sp(PrestoAllDataTypeTest.scala:182)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
Sep 15, 2017 9:50:02 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095002_00016_hq8e7 :: Transaction:[577d29d5-e401-4b78-b74a-17dacfd977bf] :: elapsed 58ms :: planning 32ms :: scheduling 26ms :: running 0ms :: finishing 26ms :: begin 2017-09-15T09:50:02.570Z :: end 2017-09-15T09:50:02.628Z
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m ...[0m
2017-09-15 09:50:02 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID>2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
Sep 15, 2017 9:50:02 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095002_00017_hq8e7 :: Transaction:[a3a5aa4b-6f2d-41db-9884-54ebc02a429a] :: elapsed 84ms :: planning 29ms :: scheduling 55ms :: running 0ms :: finishing 55ms :: begin 2017-09-15T09:50:02.643Z :: end 2017-09-15T09:50:02.727Z
[31m- select int type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:197)[0m
[31m- test and filter clause with greater than expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:223)[0m
2017-09-15 09:50:03 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
Sep 15, 2017 9:50:03 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095002_00018_hq8e7 :: Transaction:[c76ee8fb-2e68-4253-bbe2-b0076a13e821] :: elapsed 267ms :: planning 182ms :: scheduling 85ms :: running 0ms :: finishing 85ms :: begin 2017-09-15T09:50:02.769Z :: end 2017-09-15T09:50:03.036Z
2017-09-15 09:50:03 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS<=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID LIMIT 2
[31m- test and filter clause with greater than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:267)[0m
Sep 15, 2017 9:50:03 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095003_00019_hq8e7 :: Transaction:[9cfb004e-24e7-466d-94a2-f1203e56c0b2] :: elapsed 134ms :: planning 68ms :: scheduling 66ms :: running 0ms :: finishing 66ms :: begin 2017-09-15T09:50:03.094Z :: end 2017-09-15T09:50:03.228Z
2017-09-15 09:50:03 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE BONUS=1234.444
[31m- test and filter clause with less than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:292)[0m
Sep 15, 2017 9:50:03 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095003_00020_hq8e7 :: Transaction:[801b6928-39b6-4736-99f8-a7e4221ec806] :: elapsed 114ms :: planning 61ms :: scheduling 53ms :: running 0ms :: finishing 53ms :: begin 2017-09-15T09:50:03.252Z :: end 2017-09-15T09:50:03.366Z
Sep 15, 2017 9:50:03 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095003_00021_hq8e7 :: Transaction:[92e4f765-facc-4652-9f39-7ce48bdfe71b] :: elapsed 56ms :: planning 38ms :: scheduling 18ms :: running 0ms :: finishing 18ms :: begin 2017-09-15T09:50:03.384Z :: end 2017-09-15T09:50:03.440Z
2017-09-15 09:50:03 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID<2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test equal to expression on decimal value *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:301)[0m
2017-09-15 09:50:03 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE IN('phone1848','phone706')
[31m- test less than expression with and operator *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:317)[0m
Sep 15, 2017 9:50:03 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095003_00022_hq8e7 :: Transaction:[bd4027d1-0541-4116-b127-74ec7caf4ddf] :: elapsed 134ms :: planning 74ms :: scheduling 60ms :: running 0ms :: finishing 60ms :: begin 2017-09-15T09:50:03.461Z :: end 2017-09-15T09:50:03.595Z
2017-09-15 09:50:04 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE NOT IN('phone1848','phone706')
[31m- test the result for in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:327)[0m
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095003_00023_hq8e7 :: Transaction:[1716b154-8579-4a5e-8261-ddb37cc8fe2a] :: elapsed 401ms :: planning 381ms :: scheduling 20ms :: running 0ms :: finishing 20ms :: begin 2017-09-15T09:50:03.622Z :: end 2017-09-15T09:50:04.023Z
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095004_00024_hq8e7 :: Transaction:[f5e9f160-6885-4d6c-b242-fbb208add3a5] :: elapsed 65ms :: planning 48ms :: scheduling 17ms :: running 0ms :: finishing 17ms :: begin 2017-09-15T09:50:04.048Z :: end 2017-09-15T09:50:04.113Z
2017-09-15 09:50:04 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE DATE IS NULL
[31m- test the result for not in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:341)[0m
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095004_00025_hq8e7 :: Transaction:[3118cc06-e749-43d4-8887-044e0226b16f] :: elapsed 56ms :: planning 33ms :: scheduling 23ms :: running 0ms :: finishing 23ms :: begin 2017-09-15T09:50:04.129Z :: end 2017-09-15T09:50:04.185Z
2017-09-15 09:50:04 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DATE IS NOT NULL AND ID=9
[31m- test for null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:347)[0m
[31m- test for not null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:354)[0m
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095004_00026_hq8e7 :: Transaction:[dee64055-34f9-4979-a0bf-351322539215] :: elapsed 63ms :: planning 40ms :: scheduling 23ms :: running 0ms :: finishing 23ms :: begin 2017-09-15T09:50:04.205Z :: end 2017-09-15T09:50:04.268Z
2017-09-15 09:50:04 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NOT NULL AND ID=9
[31m- test for not null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:362)[0m
2017-09-15 09:50:04 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NULL AND ID=1
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095004_00027_hq8e7 :: Transaction:[0500319b-0f74-4d84-8243-f35ce8568228] :: elapsed 55ms :: planning 31ms :: scheduling 24ms :: running 0ms :: finishing 24ms :: begin 2017-09-15T09:50:04.281Z :: end 2017-09-15T09:50:04.336Z
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095004_00028_hq8e7 :: Transaction:[33dd3b5a-ab98-41e6-ada3-99e9ee79056f] :: elapsed 52ms :: planning 39ms :: scheduling 13ms :: running 0ms :: finishing 13ms :: begin 2017-09-15T09:50:04.356Z :: end 2017-09-15T09:50:04.408Z
2017-09-15 09:50:04 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT SHORTFIELD from testdb.testtable ORDER BY SHORTFIELD
[31m- test for null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:369)[0m
2017-09-15 09:50:04 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD IS NULL ORDER BY SHORTFIELD
[31m- test the result for short datatype with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:385)[0m
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095004_00029_hq8e7 :: Transaction:[659c0aef-7cd0-4398-a1e5-9c573d62bcec] :: elapsed 91ms :: planning 27ms :: scheduling 64ms :: running 0ms :: finishing 64ms :: begin 2017-09-15T09:50:04.423Z :: end 2017-09-15T09:50:04.514Z
[31m- test the result for short datatype in clause where field is null *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:393)[0m
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095004_00030_hq8e7 :: Transaction:[cbe4c977-285c-4f4a-9e38-a7a6975db663] :: elapsed 52ms :: planning 33ms :: scheduling 19ms :: running 0ms :: finishing 19ms :: begin 2017-09-15T09:50:04.527Z :: end 2017-09-15T09:50:04.579Z
2017-09-15 09:50:04 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD>11
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_095004_00031_hq8e7 :: Transaction:[a4366ea3-1ab9-434a-8a7f-1a9f19ce0168] :: elapsed 53ms :: planning 35ms :: scheduling 18ms :: running 0ms :: finishing 18ms :: begin 2017-09-15T09:50:04.593Z :: end 2017-09-15T09:50:04.646Z
[31m- test the result for short datatype with greater than operator *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:401)[0m
Sep 15, 2017 9:50:04 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 9:50:04 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4ef277ef{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:8086}
Sep 15, 2017 9:50:06 AM io.airlift.log.Logger warn
WARNING: Error fetching memory info from http://127.0.0.1:8086/v1/memory: Server refused connection: http://127.0.0.1:8086/v1/memory
Sep 15, 2017 9:50:07 AM io.airlift.log.Logger warn
WARNING: Error fetching node state from http://127.0.0.1:8086/v1/info/state: Server refused connection: http://127.0.0.1:8086/v1/info/state
Sep 15, 2017 9:50:07 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@2c51c756{/,null,UNAVAILABLE,@http}
Sep 15, 2017 9:50:07 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=12,q=14} Couldn't stop Thread[http-worker-253,5,]
Sep 15, 2017 9:50:07 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=7,q=13} Couldn't stop Thread[http-worker-371,5,]
Sep 15, 2017 9:50:07 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=4,q=13} Couldn't stop Thread[http-worker-212,5,]
Sep 15, 2017 9:50:07 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=0,q=12} Couldn't stop Thread[http-worker-210,5,]
Sep 15, 2017 9:50:07 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=0,q=12} Couldn't stop Thread[http-worker-214,5,]
Sep 15, 2017 9:50:07 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 9:50:07 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 9:50:07 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@31c0c7e5{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:37405}
2017-09-15 09:50:07 INFO AbstractDataLoadProcessorStep:150 - Thread-2 Rows processed in step Data Writer : 10
2017-09-15 09:50:07 INFO AbstractDataLoadProcessorStep:150 - Thread-3 Rows processed in step Data Converter : 10
2017-09-15 09:50:07 INFO AbstractDataLoadProcessorStep:150 - Thread-4 Rows processed in step Input Processor : 10
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@67f266bd{/,null,UNAVAILABLE,@http}
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=12<=200,i=8,q=9} Couldn't stop Thread[http-worker-300,5,]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=12<=200,i=3,q=8} Couldn't stop Thread[http-worker-156,5,]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=12<=200,i=0,q=7} Couldn't stop Thread[http-worker-161,5,]
Sep 15, 2017 9:50:08 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 9:50:08 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4adcc981{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:45930}
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@729d6ee2{/,null,UNAVAILABLE,@http}
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=11,q=12} Couldn't stop Thread[http-worker-421,5,main]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=5,q=10} Couldn't stop Thread[http-worker-252,5,]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=3,q=9} Couldn't stop Thread[http-worker-381,5,]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=0,q=7} Couldn't stop Thread[http-worker-250,5,]
Sep 15, 2017 9:50:08 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 9:50:08 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@38929da{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:36076}
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@1e6d30c0{/,null,UNAVAILABLE,@http}
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=10,q=10} Couldn't stop Thread[http-worker-85,5,main]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=5,q=9} Couldn't stop Thread[http-worker-422,5,main]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=0,q=7} Couldn't stop Thread[http-worker-373,5,]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=0,q=7} Couldn't stop Thread[http-worker-372,5,]
Sep 15, 2017 9:50:08 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 9:50:08 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@7da635c0{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:40963}
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@3d615b2e{/,null,UNAVAILABLE,@http}
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=8,q=8} Couldn't stop Thread[http-worker-65,5,main]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=4,q=7} Couldn't stop Thread[http-worker-93,5,]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=2,q=7} Couldn't stop Thread[http-worker-427,5,]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=2,q=7} Couldn't stop Thread[http-worker-426,5,main]
Sep 15, 2017 9:50:08 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=2,q=7} Couldn't stop Thread[http-worker-425,5,main]
Sep 15, 2017 9:50:08 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
2017-09-15 09:50:08 INFO PrestoServer$:88 - ***** Stopping The Server *****
[36mRun completed in 21 seconds, 429 milliseconds.[0m
[36mTotal number of tests run: 32[0m
[36mSuites: completed 2, aborted 0[0m
[36mTests: succeeded 6, failed 26, canceled 0, ignored 0, pending 0[0m
[31m*** 26 TESTS FAILED ***[0m
[JENKINS] Recording test results
Build failed in Jenkins: carbondata-master-spark-2.1 » Apache CarbonData :: presto #1384
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/carbondata-master-spark-2.1/org.apache.carbondata$carbondata-presto/1384/display/redirect>
------------------------------------------
[...truncated 174.27 KB...]
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
2017-09-15 08:55:32 INFO PrestoServer$:101 - ***** executing the query *****
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for sum()with out distinct operator for decimal column in presto[0m
Sep 15, 2017 8:55:32 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085532_00009_j5vw9 :: Transaction:[593c34bf-5c4f-4d5e-9db5-8a105d223393] :: elapsed 173ms :: planning 47ms :: scheduling 126ms :: running 0ms :: finishing 126ms :: begin 2017-09-15T08:55:32.323Z :: end 2017-09-15T08:55:32.496Z
2017-09-15 08:55:32 INFO PrestoServer$:101 - ***** executing the query *****
SELECT AVG(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 8:55:32 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085532_00010_j5vw9 :: Transaction:[0b339f53-b244-4d90-a9eb-e4fdcaa86ff6] :: elapsed 117ms :: planning 26ms :: scheduling 91ms :: running 0ms :: finishing 91ms :: begin 2017-09-15T08:55:32.512Z :: end 2017-09-15T08:55:32.629Z
[31m- test the result for sum() with distinct operator for decimal column in presto *** FAILED ***[0m
[31m java.lang.NullPointerException:[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply$mcV$sp(PrestoAllDataTypeTest.scala:115)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m at org.scalatest.FunSuiteLike$$anon$1.apply(FunSuiteLike.scala:166)[0m
[31m at org.scalatest.Suite$class.withFixture(Suite.scala:1122)[0m
[31m ...[0m
[32m- test the result for avg() with distinct operator on decimal coin presto[0m
2017-09-15 08:55:32 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MIN(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 8:55:32 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085532_00011_j5vw9 :: Transaction:[620dfd5a-3f50-47e4-8c83-02d78fd66ecb] :: elapsed 168ms :: planning 39ms :: scheduling 129ms :: running 0ms :: finishing 129ms :: begin 2017-09-15T08:55:32.654Z :: end 2017-09-15T08:55:32.822Z
[32m- test the result for min() with distinct operator in decimalType of presto[0m
Sep 15, 2017 8:55:32 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085532_00012_j5vw9 :: Transaction:[45d7e407-3d8c-485f-afaf-f576d380e3f0] :: elapsed 67ms :: planning 37ms :: scheduling 30ms :: running 0ms :: finishing 30ms :: begin 2017-09-15T08:55:32.834Z :: end 2017-09-15T08:55:32.901Z
2017-09-15 08:55:32 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MAX(BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for max() with distinct operator in decimalType of presto[0m
Sep 15, 2017 8:55:32 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085532_00013_j5vw9 :: Transaction:[acf53826-3dbc-4e89-95a2-ac5a31dbd9e3] :: elapsed 59ms :: planning 35ms :: scheduling 24ms :: running 0ms :: finishing 24ms :: begin 2017-09-15T08:55:32.913Z :: end 2017-09-15T08:55:32.972Z
2017-09-15 08:55:32 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT BONUS FROM TESTDB.TESTTABLE ORDER BY BONUS limit 3
2017-09-15 08:55:33 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE ORDER BY NAME
[31m- select decimal data type with ORDER BY clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:147)[0m
Sep 15, 2017 8:55:33 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085532_00014_j5vw9 :: Transaction:[858eab46-0aae-4534-aa76-b46742617fcf] :: elapsed 139ms :: planning 30ms :: scheduling 109ms :: running 0ms :: finishing 109ms :: begin 2017-09-15T08:55:33.005Z :: end 2017-09-15T08:55:33.144Z
2017-09-15 08:55:33 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DATE FROM TESTDB.TESTTABLE ORDER BY DATE
[31m- select string type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:162)[0m
Sep 15, 2017 8:55:33 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085533_00015_j5vw9 :: Transaction:[600ab02b-6632-4433-8dd4-8744838324df] :: elapsed 82ms :: planning 25ms :: scheduling 57ms :: running 0ms :: finishing 57ms :: begin 2017-09-15T08:55:33.160Z :: end 2017-09-15T08:55:33.242Z
2017-09-15 08:55:33 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT ID FROM TESTDB.TESTTABLE ORDER BY ID
Sep 15, 2017 8:55:33 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085533_00016_j5vw9 :: Transaction:[51e5824e-f7d6-453e-bd4f-197ae8dcccda] :: elapsed 41ms :: planning 22ms :: scheduling 19ms :: running 0ms :: finishing 19ms :: begin 2017-09-15T08:55:33.260Z :: end 2017-09-15T08:55:33.301Z
[31m- select DATE type with order by clause *** FAILED ***[0m
[31m java.util.NoSuchElementException: head of empty list[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:420)[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:417)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply$mcV$sp(PrestoAllDataTypeTest.scala:182)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m ...[0m
2017-09-15 08:55:33 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID>2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- select int type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:197)[0m
Sep 15, 2017 8:55:33 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085533_00017_j5vw9 :: Transaction:[ec8faf69-2472-4f15-9012-6e71ae778ed7] :: elapsed 83ms :: planning 40ms :: scheduling 43ms :: running 0ms :: finishing 43ms :: begin 2017-09-15T08:55:33.312Z :: end 2017-09-15T08:55:33.395Z
[31m- test and filter clause with greater than expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:223)[0m
2017-09-15 08:55:33 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
Sep 15, 2017 8:55:33 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085533_00018_j5vw9 :: Transaction:[43cf13ff-2b20-44af-aa4f-7b36758606cf] :: elapsed 214ms :: planning 143ms :: scheduling 71ms :: running 0ms :: finishing 71ms :: begin 2017-09-15T08:55:33.429Z :: end 2017-09-15T08:55:33.643Z
[31m- test and filter clause with greater than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:267)[0m
2017-09-15 08:55:33 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS<=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID LIMIT 2
Sep 15, 2017 8:55:33 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085533_00019_j5vw9 :: Transaction:[2bdbbaa4-e4b3-442d-a9c6-300ea0af9b90] :: elapsed 98ms :: planning 57ms :: scheduling 41ms :: running 0ms :: finishing 41ms :: begin 2017-09-15T08:55:33.671Z :: end 2017-09-15T08:55:33.769Z
[31m- test and filter clause with less than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:292)[0m
2017-09-15 08:55:33 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE BONUS=1234.444
Sep 15, 2017 8:55:33 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085533_00020_j5vw9 :: Transaction:[269db722-bd43-4759-bf45-2c8606c1cf61] :: elapsed 78ms :: planning 43ms :: scheduling 35ms :: running 0ms :: finishing 35ms :: begin 2017-09-15T08:55:33.788Z :: end 2017-09-15T08:55:33.866Z
Sep 15, 2017 8:55:33 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085533_00021_j5vw9 :: Transaction:[beca9fdb-b2c6-41c7-a716-c61fae604376] :: elapsed 50ms :: planning 32ms :: scheduling 18ms :: running 0ms :: finishing 18ms :: begin 2017-09-15T08:55:33.883Z :: end 2017-09-15T08:55:33.933Z
[31m- test equal to expression on decimal value *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:301)[0m
2017-09-15 08:55:33 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID<2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test less than expression with and operator *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:317)[0m
2017-09-15 08:55:34 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE IN('phone1848','phone706')
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085533_00022_j5vw9 :: Transaction:[ccfda4e0-cde7-410e-8615-04cc4b9de219] :: elapsed 92ms :: planning 52ms :: scheduling 40ms :: running 0ms :: finishing 40ms :: begin 2017-09-15T08:55:33.950Z :: end 2017-09-15T08:55:34.042Z
2017-09-15 08:55:34 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE NOT IN('phone1848','phone706')
[31m- test the result for in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:327)[0m
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085534_00023_j5vw9 :: Transaction:[a9aca817-8bb8-446e-93ca-56514a992eb6] :: elapsed 313ms :: planning 299ms :: scheduling 14ms :: running 0ms :: finishing 14ms :: begin 2017-09-15T08:55:34.067Z :: end 2017-09-15T08:55:34.380Z
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085534_00024_j5vw9 :: Transaction:[c5f10f93-29cc-4ac7-bea4-0b1c2e341846] :: elapsed 48ms :: planning 33ms :: scheduling 15ms :: running 0ms :: finishing 15ms :: begin 2017-09-15T08:55:34.392Z :: end 2017-09-15T08:55:34.440Z
2017-09-15 08:55:34 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE DATE IS NULL
[31m- test the result for not in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:341)[0m
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085534_00025_j5vw9 :: Transaction:[b3fc1a20-94ee-42f2-b332-ce6c124b7313] :: elapsed 50ms :: planning 30ms :: scheduling 20ms :: running 0ms :: finishing 20ms :: begin 2017-09-15T08:55:34.457Z :: end 2017-09-15T08:55:34.507Z
2017-09-15 08:55:34 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DATE IS NOT NULL AND ID=9
[31m- test for null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:347)[0m
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085534_00026_j5vw9 :: Transaction:[864e8270-9b94-4568-8c20-a35b0a187708] :: elapsed 44ms :: planning 30ms :: scheduling 14ms :: running 0ms :: finishing 14ms :: begin 2017-09-15T08:55:34.519Z :: end 2017-09-15T08:55:34.563Z
2017-09-15 08:55:34 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NOT NULL AND ID=9
[31m- test for not null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:354)[0m
[31m- test for not null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:362)[0m
2017-09-15 08:55:34 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NULL AND ID=1
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085534_00027_j5vw9 :: Transaction:[fc67ad08-507d-40ef-8b76-bc9025bb2b58] :: elapsed 85ms :: planning 35ms :: scheduling 50ms :: running 0ms :: finishing 50ms :: begin 2017-09-15T08:55:34.575Z :: end 2017-09-15T08:55:34.660Z
[31m- test for null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:369)[0m
2017-09-15 08:55:34 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT SHORTFIELD from testdb.testtable ORDER BY SHORTFIELD
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085534_00028_j5vw9 :: Transaction:[62ae91ae-353d-4d72-8844-33905f456aa0] :: elapsed 42ms :: planning 27ms :: scheduling 15ms :: running 0ms :: finishing 15ms :: begin 2017-09-15T08:55:34.676Z :: end 2017-09-15T08:55:34.718Z
2017-09-15 08:55:34 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD IS NULL ORDER BY SHORTFIELD
[31m- test the result for short datatype with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:385)[0m
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085534_00029_j5vw9 :: Transaction:[b6f07a31-7560-4cda-a263-ee18a4c4e672] :: elapsed 64ms :: planning 23ms :: scheduling 41ms :: running 0ms :: finishing 41ms :: begin 2017-09-15T08:55:34.729Z :: end 2017-09-15T08:55:34.793Z
[31m- test the result for short datatype in clause where field is null *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:393)[0m
2017-09-15 08:55:34 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD>11
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085534_00030_j5vw9 :: Transaction:[68436785-3aa9-4df1-90f5-1744725f7577] :: elapsed 41ms :: planning 22ms :: scheduling 19ms :: running 0ms :: finishing 19ms :: begin 2017-09-15T08:55:34.805Z :: end 2017-09-15T08:55:34.846Z
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085534_00031_j5vw9 :: Transaction:[cf25fd8d-5fa0-4752-976e-74a0bf315e17] :: elapsed 41ms :: planning 25ms :: scheduling 16ms :: running 0ms :: finishing 16ms :: begin 2017-09-15T08:55:34.859Z :: end 2017-09-15T08:55:34.900Z
[31m- test the result for short datatype with greater than operator *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:401)[0m
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:55:34 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4ef277ef{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:8086}
Sep 15, 2017 8:55:34 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@2c51c756{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:55:34 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=12,q=13} Couldn't stop Thread[http-worker-211,5,]
Sep 15, 2017 8:55:34 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=2,q=12} Couldn't stop Thread[http-worker-212,5,]
Sep 15, 2017 8:55:34 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=0,q=12} Couldn't stop Thread[http-worker-216,5,]
Sep 15, 2017 8:55:34 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=0,q=12} Couldn't stop Thread[http-worker-310,5,]
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:55:34 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:55:34 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@31c0c7e5{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:37276}
2017-09-15 08:55:39 INFO AbstractDataLoadProcessorStep:150 - Thread-2 Rows processed in step Data Writer : 10
2017-09-15 08:55:39 INFO AbstractDataLoadProcessorStep:150 - Thread-4 Rows processed in step Input Processor : 10
2017-09-15 08:55:39 INFO AbstractDataLoadProcessorStep:150 - Thread-3 Rows processed in step Data Converter : 10
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@67f266bd{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=12,q=12} Couldn't stop Thread[http-worker-161,5,main]
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=6,q=11} Couldn't stop Thread[http-worker-153,5,]
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=3,q=11} Couldn't stop Thread[http-worker-409,5,]
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=0,q=10} Couldn't stop Thread[http-worker-358,5,]
Sep 15, 2017 8:55:39 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:55:39 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4adcc981{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:37889}
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@729d6ee2{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=10,q=10} Couldn't stop Thread[http-worker-300,5,main]
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=7,q=10} Couldn't stop Thread[http-worker-415,5,]
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=3,q=9} Couldn't stop Thread[http-worker-414,5,main]
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=3,q=9} Couldn't stop Thread[http-worker-413,5,main]
Sep 15, 2017 8:55:39 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=1,q=9} Couldn't stop Thread[http-worker-118,5,]
Sep 15, 2017 8:55:40 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:55:40 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@38929da{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:33247}
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@1e6d30c0{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=10,q=10} Couldn't stop Thread[http-worker-418,5,main]
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=6,q=9} Couldn't stop Thread[http-worker-79,5,]
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=3,q=9} Couldn't stop Thread[http-worker-85,5,]
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=2,q=9} Couldn't stop Thread[http-worker-416,5,]
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=0,q=9} Couldn't stop Thread[http-worker-80,5,]
Sep 15, 2017 8:55:40 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:55:40 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@7da635c0{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:34081}
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@3d615b2e{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=8,q=8} Couldn't stop Thread[http-worker-93,5,main]
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=4,q=7} Couldn't stop Thread[http-worker-421,5,main]
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=2,q=6} Couldn't stop Thread[http-worker-46,5,main]
Sep 15, 2017 8:55:40 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=0,q=5} Couldn't stop Thread[http-worker-419,5,]
Sep 15, 2017 8:55:40 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
2017-09-15 08:55:40 INFO PrestoServer$:88 - ***** Stopping The Server *****
[36mRun completed in 21 seconds, 482 milliseconds.[0m
[36mTotal number of tests run: 32[0m
[36mSuites: completed 2, aborted 0[0m
[36mTests: succeeded 6, failed 26, canceled 0, ignored 0, pending 0[0m
[31m*** 26 TESTS FAILED ***[0m
[JENKINS] Recording test results
Build failed in Jenkins: carbondata-master-spark-2.1 » Apache CarbonData :: presto #1383
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/carbondata-master-spark-2.1/org.apache.carbondata$carbondata-presto/1383/display/redirect>
------------------------------------------
[...truncated 174.40 KB...]
2017-09-15 08:50:53 INFO PrestoServer$:101 - ***** executing the query *****
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 8:50:53 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085053_00009_6c8cn :: Transaction:[23dc290c-79cd-46ba-83ac-0019d11ba04a] :: elapsed 175ms :: planning 35ms :: scheduling 140ms :: running 0ms :: finishing 140ms :: begin 2017-09-15T08:50:53.395Z :: end 2017-09-15T08:50:53.570Z
2017-09-15 08:50:53 INFO PrestoServer$:101 - ***** executing the query *****
SELECT AVG(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 8:50:53 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085053_00010_6c8cn :: Transaction:[e064d1de-05f4-4f49-aead-fd7456ac0a09] :: elapsed 104ms :: planning 26ms :: scheduling 78ms :: running 0ms :: finishing 78ms :: begin 2017-09-15T08:50:53.585Z :: end 2017-09-15T08:50:53.689Z
[31m- test the result for sum() with distinct operator for decimal column in presto *** FAILED ***[0m
[31m java.lang.NullPointerException:[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply$mcV$sp(PrestoAllDataTypeTest.scala:115)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m at org.scalatest.FunSuiteLike$$anon$1.apply(FunSuiteLike.scala:166)[0m
[31m at org.scalatest.Suite$class.withFixture(Suite.scala:1122)[0m
[31m ...[0m
[32m- test the result for avg() with distinct operator on decimal coin presto[0m
2017-09-15 08:50:53 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MIN(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 8:50:53 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085053_00011_6c8cn :: Transaction:[c291ffc2-8b9a-453a-bf38-fdf4ba654ac4] :: elapsed 92ms :: planning 34ms :: scheduling 58ms :: running 0ms :: finishing 58ms :: begin 2017-09-15T08:50:53.704Z :: end 2017-09-15T08:50:53.796Z
Sep 15, 2017 8:50:53 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085053_00012_6c8cn :: Transaction:[17e9a3c5-9edf-4237-a6d9-89088cd3e6e3] :: elapsed 66ms :: planning 36ms :: scheduling 30ms :: running 0ms :: finishing 30ms :: begin 2017-09-15T08:50:53.808Z :: end 2017-09-15T08:50:53.874Z
[32m- test the result for min() with distinct operator in decimalType of presto[0m
2017-09-15 08:50:53 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MAX(BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for max() with distinct operator in decimalType of presto[0m
Sep 15, 2017 8:50:53 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085053_00013_6c8cn :: Transaction:[0b144227-7d62-43f6-ad3d-99cefd7dec1f] :: elapsed 61ms :: planning 29ms :: scheduling 32ms :: running 0ms :: finishing 32ms :: begin 2017-09-15T08:50:53.885Z :: end 2017-09-15T08:50:53.946Z
2017-09-15 08:50:53 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT BONUS FROM TESTDB.TESTTABLE ORDER BY BONUS limit 3
[31m- select decimal data type with ORDER BY clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:147)[0m
2017-09-15 08:50:54 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE ORDER BY NAME
Sep 15, 2017 8:50:54 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085053_00014_6c8cn :: Transaction:[d1afee35-e056-4d83-9db4-e321e2b230c0] :: elapsed 116ms :: planning 28ms :: scheduling 88ms :: running 0ms :: finishing 88ms :: begin 2017-09-15T08:50:53.965Z :: end 2017-09-15T08:50:54.081Z
2017-09-15 08:50:54 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DATE FROM TESTDB.TESTTABLE ORDER BY DATE
[31m- select string type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:162)[0m
Sep 15, 2017 8:50:54 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085054_00015_6c8cn :: Transaction:[86e001dd-eb2f-4787-92ba-4b94437c3e08] :: elapsed 81ms :: planning 35ms :: scheduling 46ms :: running 0ms :: finishing 46ms :: begin 2017-09-15T08:50:54.100Z :: end 2017-09-15T08:50:54.181Z
2017-09-15 08:50:54 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT ID FROM TESTDB.TESTTABLE ORDER BY ID
Sep 15, 2017 8:50:54 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085054_00016_6c8cn :: Transaction:[f9a27026-bee3-47d3-a543-6a02d035f687] :: elapsed 48ms :: planning 24ms :: scheduling 24ms :: running 0ms :: finishing 24ms :: begin 2017-09-15T08:50:54.202Z :: end 2017-09-15T08:50:54.250Z
[31m- select DATE type with order by clause *** FAILED ***[0m
[31m java.util.NoSuchElementException: head of empty list[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:420)[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:417)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply$mcV$sp(PrestoAllDataTypeTest.scala:182)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m ...[0m
2017-09-15 08:50:54 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID>2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- select int type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:197)[0m
Sep 15, 2017 8:50:54 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085054_00017_6c8cn :: Transaction:[93efd492-b1ad-4faf-a72a-3628e8425423] :: elapsed 60ms :: planning 24ms :: scheduling 36ms :: running 0ms :: finishing 36ms :: begin 2017-09-15T08:50:54.262Z :: end 2017-09-15T08:50:54.322Z
2017-09-15 08:50:54 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test and filter clause with greater than expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:223)[0m
Sep 15, 2017 8:50:54 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085054_00018_6c8cn :: Transaction:[e9365ce5-e618-4035-bdd7-b61463896a44] :: elapsed 171ms :: planning 116ms :: scheduling 55ms :: running 0ms :: finishing 55ms :: begin 2017-09-15T08:50:54.356Z :: end 2017-09-15T08:50:54.527Z
[31m- test and filter clause with greater than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:267)[0m
2017-09-15 08:50:54 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS<=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID LIMIT 2
Sep 15, 2017 8:50:54 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085054_00019_6c8cn :: Transaction:[c1aed66e-005c-44d7-a8c8-4ecb4b45057b] :: elapsed 104ms :: planning 69ms :: scheduling 35ms :: running 0ms :: finishing 35ms :: begin 2017-09-15T08:50:54.550Z :: end 2017-09-15T08:50:54.654Z
[31m- test and filter clause with less than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:292)[0m
2017-09-15 08:50:54 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE BONUS=1234.444
Sep 15, 2017 8:50:54 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085054_00020_6c8cn :: Transaction:[626a9578-fd7d-4cf4-bf88-0de517c7cbfc] :: elapsed 69ms :: planning 37ms :: scheduling 32ms :: running 0ms :: finishing 32ms :: begin 2017-09-15T08:50:54.674Z :: end 2017-09-15T08:50:54.743Z
Sep 15, 2017 8:50:54 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085054_00021_6c8cn :: Transaction:[0b9805ef-cd37-4ffc-a885-e5f25d1b8cf9] :: elapsed 47ms :: planning 27ms :: scheduling 20ms :: running 0ms :: finishing 20ms :: begin 2017-09-15T08:50:54.760Z :: end 2017-09-15T08:50:54.807Z
2017-09-15 08:50:54 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID<2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test equal to expression on decimal value *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:301)[0m
2017-09-15 08:50:54 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE IN('phone1848','phone706')
[31m- test less than expression with and operator *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:317)[0m
Sep 15, 2017 8:50:54 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085054_00022_6c8cn :: Transaction:[23df2e60-f4a3-486c-a293-aa3f56acad23] :: elapsed 104ms :: planning 54ms :: scheduling 50ms :: running 0ms :: finishing 50ms :: begin 2017-09-15T08:50:54.824Z :: end 2017-09-15T08:50:54.928Z
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085054_00023_6c8cn :: Transaction:[1002650a-5472-490f-9f88-a764114e3534] :: elapsed 330ms :: planning 311ms :: scheduling 19ms :: running 0ms :: finishing 19ms :: begin 2017-09-15T08:50:54.951Z :: end 2017-09-15T08:50:55.281Z
2017-09-15 08:50:55 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE NOT IN('phone1848','phone706')
[31m- test the result for in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:327)[0m
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085055_00024_6c8cn :: Transaction:[b26d5038-1af9-4ba0-85ed-c58bfbe89c42] :: elapsed 54ms :: planning 37ms :: scheduling 17ms :: running 0ms :: finishing 17ms :: begin 2017-09-15T08:50:55.296Z :: end 2017-09-15T08:50:55.350Z
2017-09-15 08:50:55 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE DATE IS NULL
[31m- test the result for not in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:341)[0m
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085055_00025_6c8cn :: Transaction:[f3ca6fe3-926d-4196-8d40-b1a73279d492] :: elapsed 41ms :: planning 22ms :: scheduling 19ms :: running 0ms :: finishing 19ms :: begin 2017-09-15T08:50:55.363Z :: end 2017-09-15T08:50:55.404Z
2017-09-15 08:50:55 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DATE IS NOT NULL AND ID=9
[31m- test for null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:347)[0m
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085055_00026_6c8cn :: Transaction:[0f5bb643-fa74-485e-abad-ae921ee5bf88] :: elapsed 49ms :: planning 33ms :: scheduling 16ms :: running 0ms :: finishing 16ms :: begin 2017-09-15T08:50:55.423Z :: end 2017-09-15T08:50:55.472Z
2017-09-15 08:50:55 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NOT NULL AND ID=9
[31m- test for not null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:354)[0m
[31m- test for not null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:362)[0m
2017-09-15 08:50:55 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NULL AND ID=1
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085055_00027_6c8cn :: Transaction:[032c2561-789f-43b6-a0bf-52764714a802] :: elapsed 57ms :: planning 41ms :: scheduling 16ms :: running 0ms :: finishing 16ms :: begin 2017-09-15T08:50:55.485Z :: end 2017-09-15T08:50:55.542Z
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085055_00028_6c8cn :: Transaction:[02462fe1-20f5-4160-89fb-5c19cba5a75e] :: elapsed 45ms :: planning 30ms :: scheduling 15ms :: running 0ms :: finishing 15ms :: begin 2017-09-15T08:50:55.556Z :: end 2017-09-15T08:50:55.601Z
2017-09-15 08:50:55 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT SHORTFIELD from testdb.testtable ORDER BY SHORTFIELD
[31m- test for null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:369)[0m
2017-09-15 08:50:55 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD IS NULL ORDER BY SHORTFIELD
[31m- test the result for short datatype with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:385)[0m
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085055_00029_6c8cn :: Transaction:[6ef1eeea-0447-4477-bc5b-b9fd2867f4ba] :: elapsed 72ms :: planning 24ms :: scheduling 48ms :: running 0ms :: finishing 48ms :: begin 2017-09-15T08:50:55.612Z :: end 2017-09-15T08:50:55.684Z
[31m- test the result for short datatype in clause where field is null *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:393)[0m
2017-09-15 08:50:55 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD>11
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085055_00030_6c8cn :: Transaction:[5752afcc-27e9-4ee0-92e4-0849c089b891] :: elapsed 48ms :: planning 31ms :: scheduling 17ms :: running 0ms :: finishing 17ms :: begin 2017-09-15T08:50:55.699Z :: end 2017-09-15T08:50:55.747Z
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_085055_00031_6c8cn :: Transaction:[6d604deb-01bc-483a-9766-7ba375462fcc] :: elapsed 40ms :: planning 26ms :: scheduling 14ms :: running 0ms :: finishing 14ms :: begin 2017-09-15T08:50:55.759Z :: end 2017-09-15T08:50:55.799Z
[31m- test the result for short datatype with greater than operator *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:401)[0m
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:50:55 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4ef277ef{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:8086}
Sep 15, 2017 8:50:55 AM io.airlift.log.Logger warn
WARNING: Error fetching memory info from http://127.0.0.1:8086/v1/memory: Server refused connection: http://127.0.0.1:8086/v1/memory
Sep 15, 2017 8:50:57 AM io.airlift.log.Logger warn
WARNING: Error fetching memory info from http://127.0.0.1:8086/v1/memory: Server refused connection: http://127.0.0.1:8086/v1/memory
Sep 15, 2017 8:50:59 AM io.airlift.log.Logger warn
WARNING: Error fetching node state from http://127.0.0.1:8086/v1/info/state: Server refused connection: http://127.0.0.1:8086/v1/info/state
2017-09-15 08:50:59 INFO AbstractDataLoadProcessorStep:150 - Thread-2 Rows processed in step Data Writer : 10
2017-09-15 08:50:59 INFO AbstractDataLoadProcessorStep:150 - Thread-3 Rows processed in step Data Converter : 10
2017-09-15 08:50:59 INFO AbstractDataLoadProcessorStep:150 - Thread-4 Rows processed in step Input Processor : 10
Sep 15, 2017 8:50:59 AM io.airlift.log.Logger warn
WARNING: Error fetching memory info from http://127.0.0.1:8086/v1/memory: Server refused connection: http://127.0.0.1:8086/v1/memory
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@2c51c756{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=14,q=14} Couldn't stop Thread[http-worker-213,5,main]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=7,q=13} Couldn't stop Thread[http-worker-277,5,]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=4,q=13} Couldn't stop Thread[http-worker-314,5,]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=0,q=13} Couldn't stop Thread[http-worker-255,5,]
Sep 15, 2017 8:51:00 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:51:00 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@31c0c7e5{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:38555}
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@67f266bd{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=13,q=13} Couldn't stop Thread[http-worker-397,5,main]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=6,q=11} Couldn't stop Thread[http-worker-304,5,]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=3,q=11} Couldn't stop Thread[http-worker-412,5,main]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=0,q=8} Couldn't stop Thread[http-worker-414,5,]
Sep 15, 2017 8:51:00 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:51:00 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4adcc981{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:42055}
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@729d6ee2{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=11,q=12} Couldn't stop Thread[http-worker-124,5,]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=9,q=11} Couldn't stop Thread[http-worker-415,5,main]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=2,q=10} Couldn't stop Thread[http-worker-306,5,]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=0,q=10} Couldn't stop Thread[http-worker-417,5,]
Sep 15, 2017 8:51:00 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:51:00 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@38929da{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:38018}
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@1e6d30c0{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=11,q=11} Couldn't stop Thread[http-worker-298,5,]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=6,q=11} Couldn't stop Thread[http-worker-420,5,]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=2,q=10} Couldn't stop Thread[http-worker-79,5,main]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=0,q=10} Couldn't stop Thread[http-worker-253,5,]
Sep 15, 2017 8:51:00 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:51:00 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@7da635c0{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:43221}
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@3d615b2e{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=5,q=8} Couldn't stop Thread[http-worker-422,5,main]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=2,q=8} Couldn't stop Thread[http-worker-421,5,]
Sep 15, 2017 8:51:00 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=1,q=8} Couldn't stop Thread[http-worker-423,5,main]
Sep 15, 2017 8:51:00 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
2017-09-15 08:51:00 INFO PrestoServer$:88 - ***** Stopping The Server *****
[36mRun completed in 22 seconds, 56 milliseconds.[0m
[36mTotal number of tests run: 32[0m
[36mSuites: completed 2, aborted 0[0m
[36mTests: succeeded 6, failed 26, canceled 0, ignored 0, pending 0[0m
[31m*** 26 TESTS FAILED ***[0m
[JENKINS] Recording test results
Build failed in Jenkins: carbondata-master-spark-2.1 » Apache CarbonData :: presto #1382
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/carbondata-master-spark-2.1/org.apache.carbondata$carbondata-presto/1382/display/redirect>
------------------------------------------
[...truncated 211.19 KB...]
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:83)[0m
Sep 15, 2017 8:11:25 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081124_00005_n4nzz :: Transaction:[be636804-a39d-4862-9d74-d75a274303d7] :: elapsed 524ms :: planning 120ms :: scheduling 404ms :: running 0ms :: finishing 404ms :: begin 2017-09-15T08:11:24.454Z :: end 2017-09-15T08:11:24.978Z
2017-09-15 08:11:25 INFO PrestoServer$:101 - ***** executing the query *****
SELECT COUNT(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
[31m- test the result for max() with distinct operator in presto *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:89)[0m
Sep 15, 2017 8:11:25 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081125_00006_n4nzz :: Transaction:[cc8fb95c-4d3d-4094-a7f7-49d3426d1eeb] :: elapsed 431ms :: planning 86ms :: scheduling 345ms :: running 0ms :: finishing 345ms :: begin 2017-09-15T08:11:25.005Z :: end 2017-09-15T08:11:25.436Z
2017-09-15 08:11:25 INFO AbstractDataLoadProcessorStep:150 - Thread-2 Rows processed in step Data Writer : 10
2017-09-15 08:11:25 INFO AbstractDataLoadProcessorStep:150 - Thread-4 Rows processed in step Input Processor : 10
2017-09-15 08:11:25 INFO AbstractDataLoadProcessorStep:150 - Thread-3 Rows processed in step Data Converter : 10
[32m- test the result for count()clause with distinct operator on decimal column in presto[0m
2017-09-15 08:11:25 INFO PrestoServer$:101 - ***** executing the query *****
SELECT COUNT(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 8:11:25 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081125_00007_n4nzz :: Transaction:[d967052d-747d-4daf-897b-f0d2248f8fcf] :: elapsed 396ms :: planning 115ms :: scheduling 281ms :: running 0ms :: finishing 281ms :: begin 2017-09-15T08:11:25.461Z :: end 2017-09-15T08:11:25.857Z
Sep 15, 2017 8:11:26 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081125_00008_n4nzz :: Transaction:[8eec3028-215c-417c-a2df-d83a259a9d14] :: elapsed 117ms :: planning 59ms :: scheduling 58ms :: running 0ms :: finishing 58ms :: begin 2017-09-15T08:11:25.891Z :: end 2017-09-15T08:11:26.008Z
[32m- test the result for count()clause with out distinct operator on decimal column in presto[0m
2017-09-15 08:11:26 INFO PrestoServer$:101 - ***** executing the query *****
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for sum()with out distinct operator for decimal column in presto[0m
2017-09-15 08:11:26 INFO PrestoServer$:101 - ***** executing the query *****
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 8:11:26 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081126_00009_n4nzz :: Transaction:[ca353679-76ab-4b18-9f4f-4b8b8e2e1676] :: elapsed 397ms :: planning 93ms :: scheduling 304ms :: running 0ms :: finishing 304ms :: begin 2017-09-15T08:11:26.034Z :: end 2017-09-15T08:11:26.431Z
2017-09-15 08:11:26 INFO PrestoServer$:101 - ***** executing the query *****
SELECT AVG(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
[31m- test the result for sum() with distinct operator for decimal column in presto *** FAILED ***[0m
[31m java.lang.NullPointerException:[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply$mcV$sp(PrestoAllDataTypeTest.scala:115)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m at org.scalatest.FunSuiteLike$$anon$1.apply(FunSuiteLike.scala:166)[0m
[31m at org.scalatest.Suite$class.withFixture(Suite.scala:1122)[0m
[31m ...[0m
Sep 15, 2017 8:11:26 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081126_00010_n4nzz :: Transaction:[72c29fe4-363c-419a-8924-a9afbd882286] :: elapsed 253ms :: planning 60ms :: scheduling 193ms :: running 0ms :: finishing 193ms :: begin 2017-09-15T08:11:26.461Z :: end 2017-09-15T08:11:26.714Z
[32m- test the result for avg() with distinct operator on decimal coin presto[0m
2017-09-15 08:11:27 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MIN(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 8:11:27 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081126_00011_n4nzz :: Transaction:[ff9d0fb3-8306-4164-82bc-99d407af6b8c] :: elapsed 270ms :: planning 99ms :: scheduling 171ms :: running 0ms :: finishing 171ms :: begin 2017-09-15T08:11:26.750Z :: end 2017-09-15T08:11:27.020Z
[32m- test the result for min() with distinct operator in decimalType of presto[0m
Sep 15, 2017 8:11:27 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081127_00012_n4nzz :: Transaction:[b930d00f-221a-4219-9a76-b18c86569086] :: elapsed 194ms :: planning 98ms :: scheduling 96ms :: running 0ms :: finishing 96ms :: begin 2017-09-15T08:11:27.056Z :: end 2017-09-15T08:11:27.250Z
2017-09-15 08:11:27 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MAX(BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for max() with distinct operator in decimalType of presto[0m
2017-09-15 08:11:27 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT BONUS FROM TESTDB.TESTTABLE ORDER BY BONUS limit 3
Sep 15, 2017 8:11:27 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081127_00013_n4nzz :: Transaction:[92af6fb8-7941-46af-8de8-4f9b7f13529b] :: elapsed 146ms :: planning 89ms :: scheduling 57ms :: running 0ms :: finishing 57ms :: begin 2017-09-15T08:11:27.274Z :: end 2017-09-15T08:11:27.420Z
2017-09-15 08:11:27 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE ORDER BY NAME
[31m- select decimal data type with ORDER BY clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:147)[0m
Sep 15, 2017 8:11:27 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081127_00014_n4nzz :: Transaction:[8dd37b28-85ba-4cf8-a52b-ad69a98e4627] :: elapsed 347ms :: planning 69ms :: scheduling 278ms :: running 0ms :: finishing 278ms :: begin 2017-09-15T08:11:27.479Z :: end 2017-09-15T08:11:27.826Z
2017-09-15 08:11:28 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DATE FROM TESTDB.TESTTABLE ORDER BY DATE
[31m- select string type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:162)[0m
Sep 15, 2017 8:11:28 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081127_00015_n4nzz :: Transaction:[56087b2f-f272-4580-b7c2-984ff9a7cee1] :: elapsed 167ms :: planning 63ms :: scheduling 104ms :: running 0ms :: finishing 104ms :: begin 2017-09-15T08:11:27.849Z :: end 2017-09-15T08:11:28.016Z
2017-09-15 08:11:28 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT ID FROM TESTDB.TESTTABLE ORDER BY ID
Sep 15, 2017 8:11:28 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081128_00016_n4nzz :: Transaction:[e06f95da-2f70-45dd-9f05-779d23069a3b] :: elapsed 118ms :: planning 43ms :: scheduling 75ms :: running 0ms :: finishing 75ms :: begin 2017-09-15T08:11:28.048Z :: end 2017-09-15T08:11:28.166Z
[31m- select DATE type with order by clause *** FAILED ***[0m
[31m java.util.NoSuchElementException: head of empty list[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:420)[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:417)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply$mcV$sp(PrestoAllDataTypeTest.scala:182)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m ...[0m
[31m- select int type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:197)[0m
2017-09-15 08:11:28 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID>2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
Sep 15, 2017 8:11:28 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081128_00017_n4nzz :: Transaction:[0e6d9ffe-830c-40e1-af09-edede4cb6c0c] :: elapsed 173ms :: planning 54ms :: scheduling 119ms :: running 0ms :: finishing 119ms :: begin 2017-09-15T08:11:28.186Z :: end 2017-09-15T08:11:28.359Z
[31m- test and filter clause with greater than expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:223)[0m
2017-09-15 08:11:28 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
Sep 15, 2017 8:11:28 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081128_00018_n4nzz :: Transaction:[04afb802-7cda-4bce-b4b4-e6080cbcee30] :: elapsed 430ms :: planning 278ms :: scheduling 152ms :: running 0ms :: finishing 152ms :: begin 2017-09-15T08:11:28.452Z :: end 2017-09-15T08:11:28.882Z
[31m- test and filter clause with greater than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:267)[0m
2017-09-15 08:11:29 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS<=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID LIMIT 2
Sep 15, 2017 8:11:29 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081128_00019_n4nzz :: Transaction:[c0d871f9-a6a2-44b4-9e94-6d6ae05009ac] :: elapsed 216ms :: planning 112ms :: scheduling 104ms :: running 0ms :: finishing 104ms :: begin 2017-09-15T08:11:28.931Z :: end 2017-09-15T08:11:29.147Z
2017-09-15 08:11:29 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE BONUS=1234.444
[31m- test and filter clause with less than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:292)[0m
Sep 15, 2017 8:11:29 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081129_00020_n4nzz :: Transaction:[88475bec-f4f7-4911-a777-a317d711bcfc] :: elapsed 193ms :: planning 90ms :: scheduling 103ms :: running 0ms :: finishing 103ms :: begin 2017-09-15T08:11:29.180Z :: end 2017-09-15T08:11:29.373Z
Sep 15, 2017 8:11:29 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081129_00021_n4nzz :: Transaction:[2a808bbf-4da9-4692-a83c-49bc5cb8fe02] :: elapsed 97ms :: planning 56ms :: scheduling 41ms :: running 0ms :: finishing 41ms :: begin 2017-09-15T08:11:29.412Z :: end 2017-09-15T08:11:29.509Z
2017-09-15 08:11:29 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID<2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test equal to expression on decimal value *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:301)[0m
[31m- test less than expression with and operator *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:317)[0m
2017-09-15 08:11:29 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE IN('phone1848','phone706')
Sep 15, 2017 8:11:29 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081129_00022_n4nzz :: Transaction:[be0ebb2d-2d4c-40ab-9376-fcff14ffff95] :: elapsed 225ms :: planning 123ms :: scheduling 102ms :: running 0ms :: finishing 102ms :: begin 2017-09-15T08:11:29.544Z :: end 2017-09-15T08:11:29.769Z
2017-09-15 08:11:30 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE NOT IN('phone1848','phone706')
Sep 15, 2017 8:11:30 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081129_00023_n4nzz :: Transaction:[dd890fd5-7542-4825-9fa9-830da063d1ba] :: elapsed 705ms :: planning 673ms :: scheduling 32ms :: running 0ms :: finishing 32ms :: begin 2017-09-15T08:11:29.828Z :: end 2017-09-15T08:11:30.533Z
[31m- test the result for in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:327)[0m
2017-09-15 08:11:30 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE DATE IS NULL
[31m- test the result for not in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:341)[0m
Sep 15, 2017 8:11:30 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081130_00024_n4nzz :: Transaction:[65cadd58-d148-49ae-a3a0-d9c43e24482c] :: elapsed 108ms :: planning 79ms :: scheduling 29ms :: running 0ms :: finishing 29ms :: begin 2017-09-15T08:11:30.558Z :: end 2017-09-15T08:11:30.666Z
Sep 15, 2017 8:11:30 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081130_00025_n4nzz :: Transaction:[6d75dbf4-e040-413d-afe0-967872077e3f] :: elapsed 82ms :: planning 51ms :: scheduling 31ms :: running 0ms :: finishing 31ms :: begin 2017-09-15T08:11:30.689Z :: end 2017-09-15T08:11:30.771Z
2017-09-15 08:11:30 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DATE IS NOT NULL AND ID=9
[31m- test for null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:347)[0m
2017-09-15 08:11:30 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NOT NULL AND ID=9
Sep 15, 2017 8:11:30 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081130_00026_n4nzz :: Transaction:[7535455a-928d-487a-ae2c-32ed30bdee46] :: elapsed 99ms :: planning 73ms :: scheduling 26ms :: running 0ms :: finishing 26ms :: begin 2017-09-15T08:11:30.799Z :: end 2017-09-15T08:11:30.898Z
[31m- test for not null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:354)[0m
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081130_00027_n4nzz :: Transaction:[73c158d3-0aa4-469c-b97f-0659deb13059] :: elapsed 134ms :: planning 95ms :: scheduling 39ms :: running 0ms :: finishing 39ms :: begin 2017-09-15T08:11:30.921Z :: end 2017-09-15T08:11:31.055Z
2017-09-15 08:11:31 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NULL AND ID=1
[31m- test for not null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:362)[0m
[31m- test for null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:369)[0m
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081131_00028_n4nzz :: Transaction:[8f9baf6e-f7b5-48b0-b946-ed7e5f05d505] :: elapsed 91ms :: planning 61ms :: scheduling 30ms :: running 0ms :: finishing 30ms :: begin 2017-09-15T08:11:31.080Z :: end 2017-09-15T08:11:31.171Z
2017-09-15 08:11:31 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT SHORTFIELD from testdb.testtable ORDER BY SHORTFIELD
2017-09-15 08:11:31 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD IS NULL ORDER BY SHORTFIELD
[31m- test the result for short datatype with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:385)[0m
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081131_00029_n4nzz :: Transaction:[0a251fba-d124-4de3-b3a5-cf913d3366d6] :: elapsed 156ms :: planning 49ms :: scheduling 107ms :: running 0ms :: finishing 107ms :: begin 2017-09-15T08:11:31.200Z :: end 2017-09-15T08:11:31.356Z
2017-09-15 08:11:31 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD>11
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081131_00030_n4nzz :: Transaction:[b4b5ae41-3462-4194-9ef3-9dc25ef83656] :: elapsed 141ms :: planning 50ms :: scheduling 91ms :: running 0ms :: finishing 91ms :: begin 2017-09-15T08:11:31.372Z :: end 2017-09-15T08:11:31.513Z
[31m- test the result for short datatype in clause where field is null *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:393)[0m
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_081131_00031_n4nzz :: Transaction:[4937dabb-4df1-4f55-a55d-d13b81390787] :: elapsed 78ms :: planning 54ms :: scheduling 24ms :: running 0ms :: finishing 24ms :: begin 2017-09-15T08:11:31.549Z :: end 2017-09-15T08:11:31.627Z
[31m- test the result for short datatype with greater than operator *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:401)[0m
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4ef277ef{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:8086}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@2c51c756{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=12,q=12} Couldn't stop Thread[http-worker-377,5,main]
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=2,q=9} Couldn't stop Thread[http-worker-195,5,]
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=0,q=9} Couldn't stop Thread[http-worker-387,5,]
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@31c0c7e5{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:44639}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@67f266bd{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=10,q=10} Couldn't stop Thread[http-worker-139,5,]
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=3,q=8} Couldn't stop Thread[http-worker-143,5,]
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=0,q=7} Couldn't stop Thread[http-worker-297,5,]
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4adcc981{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:45769}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@729d6ee2{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=9<=200,i=7,q=7} Couldn't stop Thread[http-worker-296,5,]
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=9<=200,i=0,q=6} Couldn't stop Thread[http-worker-105,5,]
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=9<=200,i=0,q=6} Couldn't stop Thread[http-worker-108,5,]
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@38929da{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:39549}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@1e6d30c0{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=2,q=2} Couldn't stop Thread[http-worker-74,5,main]
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=0,q=1} Couldn't stop Thread[http-worker-392,5,]
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@7da635c0{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:37211}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@3d615b2e{/,null,UNAVAILABLE,@http}
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=8<=200,i=3,q=2} Couldn't stop Thread[http-worker-393,5,main]
Sep 15, 2017 8:11:31 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=8<=200,i=0,q=1} Couldn't stop Thread[http-worker-80,5,]
Sep 15, 2017 8:11:31 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
2017-09-15 08:11:31 INFO PrestoServer$:88 - ***** Stopping The Server *****
[36mRun completed in 38 seconds, 747 milliseconds.[0m
[36mTotal number of tests run: 32[0m
[36mSuites: completed 2, aborted 0[0m
[36mTests: succeeded 6, failed 26, canceled 0, ignored 0, pending 0[0m
[31m*** 26 TESTS FAILED ***[0m
[JENKINS] Recording test results
Build failed in Jenkins: carbondata-master-spark-2.1 » Apache CarbonData :: presto #1381
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/carbondata-master-spark-2.1/org.apache.carbondata$carbondata-presto/1381/display/redirect>
------------------------------------------
[...truncated 175.65 KB...]
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m at org.scalatest.FunSuiteLike$$anon$1.apply(FunSuiteLike.scala:166)[0m
[31m at org.scalatest.Suite$class.withFixture(Suite.scala:1122)[0m
[31m ...[0m
Sep 15, 2017 7:50:46 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075045_00011_b6j96 :: Transaction:[dabecfa2-5062-4bfb-ad83-652526302fac] :: elapsed 126ms :: planning 35ms :: scheduling 91ms :: running 0ms :: finishing 91ms :: begin 2017-09-15T07:50:45.932Z :: end 2017-09-15T07:50:46.058Z
[32m- test the result for avg() with distinct operator on decimal coin presto[0m
2017-09-15 07:50:46 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MIN(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 7:50:46 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075046_00012_b6j96 :: Transaction:[529f977a-2188-4333-91c7-1d08dfffbc1b] :: elapsed 72ms :: planning 41ms :: scheduling 31ms :: running 0ms :: finishing 31ms :: begin 2017-09-15T07:50:46.076Z :: end 2017-09-15T07:50:46.148Z
[32m- test the result for min() with distinct operator in decimalType of presto[0m
2017-09-15 07:50:46 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MAX(BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for max() with distinct operator in decimalType of presto[0m
Sep 15, 2017 7:50:46 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075046_00013_b6j96 :: Transaction:[626db998-e00f-47f9-8bd5-77ce792a3ddb] :: elapsed 65ms :: planning 33ms :: scheduling 32ms :: running 0ms :: finishing 32ms :: begin 2017-09-15T07:50:46.162Z :: end 2017-09-15T07:50:46.227Z
2017-09-15 07:50:46 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT BONUS FROM TESTDB.TESTTABLE ORDER BY BONUS limit 3
2017-09-15 07:50:46 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE ORDER BY NAME
[31m- select decimal data type with ORDER BY clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:147)[0m
Sep 15, 2017 7:50:46 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075046_00014_b6j96 :: Transaction:[f0c7c6ca-3818-4107-8cc8-365e4448fd67] :: elapsed 126ms :: planning 29ms :: scheduling 97ms :: running 0ms :: finishing 97ms :: begin 2017-09-15T07:50:46.248Z :: end 2017-09-15T07:50:46.374Z
2017-09-15 07:50:46 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DATE FROM TESTDB.TESTTABLE ORDER BY DATE
[31m- select string type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:162)[0m
Sep 15, 2017 7:50:46 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075046_00015_b6j96 :: Transaction:[1c943338-eac7-4bca-b118-887527ba8bb4] :: elapsed 79ms :: planning 26ms :: scheduling 53ms :: running 0ms :: finishing 53ms :: begin 2017-09-15T07:50:46.389Z :: end 2017-09-15T07:50:46.468Z
2017-09-15 07:50:46 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT ID FROM TESTDB.TESTTABLE ORDER BY ID
[31m- select DATE type with order by clause *** FAILED ***[0m
[31m java.util.NoSuchElementException: head of empty list[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:420)[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:417)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply$mcV$sp(PrestoAllDataTypeTest.scala:182)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m ...[0m
Sep 15, 2017 7:50:46 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075046_00016_b6j96 :: Transaction:[8bbd729e-4b68-443b-bcab-390183701452] :: elapsed 46ms :: planning 27ms :: scheduling 19ms :: running 0ms :: finishing 19ms :: begin 2017-09-15T07:50:46.495Z :: end 2017-09-15T07:50:46.541Z
2017-09-15 07:50:46 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID>2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- select int type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:197)[0m
Sep 15, 2017 7:50:46 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075046_00017_b6j96 :: Transaction:[0b82ce47-3dce-43ed-884f-d07b31f3543a] :: elapsed 74ms :: planning 28ms :: scheduling 46ms :: running 0ms :: finishing 46ms :: begin 2017-09-15T07:50:46.555Z :: end 2017-09-15T07:50:46.629Z
2017-09-15 07:50:46 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test and filter clause with greater than expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:223)[0m
Sep 15, 2017 7:50:46 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075046_00018_b6j96 :: Transaction:[519b29aa-77c7-43af-ae52-69279231003c] :: elapsed 190ms :: planning 134ms :: scheduling 56ms :: running 0ms :: finishing 56ms :: begin 2017-09-15T07:50:46.658Z :: end 2017-09-15T07:50:46.848Z
Sep 15, 2017 7:50:46 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075046_00019_b6j96 :: Transaction:[83c079d4-ba21-42ef-afdb-052a634cc570] :: elapsed 88ms :: planning 46ms :: scheduling 42ms :: running 0ms :: finishing 42ms :: begin 2017-09-15T07:50:46.875Z :: end 2017-09-15T07:50:46.963Z
[31m- test and filter clause with greater than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:267)[0m
2017-09-15 07:50:46 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS<=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID LIMIT 2
2017-09-15 07:50:47 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE BONUS=1234.444
[31m- test and filter clause with less than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:292)[0m
Sep 15, 2017 7:50:47 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075046_00020_b6j96 :: Transaction:[278c0c7e-b666-4ecf-83b9-420a9d654fe2] :: elapsed 82ms :: planning 38ms :: scheduling 44ms :: running 0ms :: finishing 44ms :: begin 2017-09-15T07:50:46.989Z :: end 2017-09-15T07:50:47.071Z
Sep 15, 2017 7:50:47 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075047_00021_b6j96 :: Transaction:[599cb68e-1b5a-4b40-a3e9-43f62e0eda51] :: elapsed 44ms :: planning 28ms :: scheduling 16ms :: running 0ms :: finishing 16ms :: begin 2017-09-15T07:50:47.087Z :: end 2017-09-15T07:50:47.131Z
[31m- test equal to expression on decimal value *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:301)[0m
2017-09-15 07:50:47 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID<2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test less than expression with and operator *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:317)[0m
2017-09-15 07:50:47 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE IN('phone1848','phone706')
Sep 15, 2017 7:50:47 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075047_00022_b6j96 :: Transaction:[cc9dee71-f056-426c-9113-e1eeeed9a4c1] :: elapsed 95ms :: planning 61ms :: scheduling 34ms :: running 0ms :: finishing 34ms :: begin 2017-09-15T07:50:47.149Z :: end 2017-09-15T07:50:47.244Z
2017-09-15 07:50:47 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE NOT IN('phone1848','phone706')
[31m- test the result for in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:327)[0m
Sep 15, 2017 7:50:47 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075047_00023_b6j96 :: Transaction:[65daa3c3-9c94-4b16-8a0f-70a7ee6da9be] :: elapsed 339ms :: planning 319ms :: scheduling 20ms :: running 0ms :: finishing 20ms :: begin 2017-09-15T07:50:47.271Z :: end 2017-09-15T07:50:47.610Z
Sep 15, 2017 7:50:47 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075047_00024_b6j96 :: Transaction:[151ca5f1-36dc-4b4a-94e5-2323eeaeadc4] :: elapsed 55ms :: planning 33ms :: scheduling 22ms :: running 0ms :: finishing 22ms :: begin 2017-09-15T07:50:47.623Z :: end 2017-09-15T07:50:47.678Z
2017-09-15 07:50:47 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE DATE IS NULL
[31m- test the result for not in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:341)[0m
Sep 15, 2017 7:50:47 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075047_00025_b6j96 :: Transaction:[ace8af2c-1d3c-4c04-b73d-474a03b1ddc5] :: elapsed 34ms :: planning 21ms :: scheduling 13ms :: running 0ms :: finishing 13ms :: begin 2017-09-15T07:50:47.692Z :: end 2017-09-15T07:50:47.726Z
2017-09-15 07:50:47 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DATE IS NOT NULL AND ID=9
[31m- test for null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:347)[0m
Sep 15, 2017 7:50:47 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075047_00026_b6j96 :: Transaction:[b356ae56-2cd7-4cb9-a17f-983c456b98a9] :: elapsed 46ms :: planning 29ms :: scheduling 17ms :: running 0ms :: finishing 17ms :: begin 2017-09-15T07:50:47.743Z :: end 2017-09-15T07:50:47.789Z
2017-09-15 07:50:47 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NOT NULL AND ID=9
[31m- test for not null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:354)[0m
[31m- test for not null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:362)[0m
2017-09-15 07:50:47 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NULL AND ID=1
Sep 15, 2017 7:50:47 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075047_00027_b6j96 :: Transaction:[b3e08fbf-a07a-431d-8c2c-ad7bceb0864c] :: elapsed 42ms :: planning 30ms :: scheduling 12ms :: running 0ms :: finishing 12ms :: begin 2017-09-15T07:50:47.801Z :: end 2017-09-15T07:50:47.843Z
Sep 15, 2017 7:50:47 AM io.airlift.log.Logger info
[31m- test for null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:369)[0m
INFO: TIMELINE: Query 20170915_075047_00028_b6j96 :: Transaction:[6ab9179a-1d9b-4ae0-bf06-4f3b1fb83ca1] :: elapsed 45ms :: planning 32ms :: scheduling 13ms :: running 0ms :: finishing 13ms :: begin 2017-09-15T07:50:47.858Z :: end 2017-09-15T07:50:47.903Z
2017-09-15 07:50:47 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT SHORTFIELD from testdb.testtable ORDER BY SHORTFIELD
2017-09-15 07:50:48 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD IS NULL ORDER BY SHORTFIELD
[31m- test the result for short datatype with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:385)[0m
Sep 15, 2017 7:50:48 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075047_00029_b6j96 :: Transaction:[210df746-b743-4eaa-83e2-7cd044d3b65c] :: elapsed 98ms :: planning 61ms :: scheduling 37ms :: running 0ms :: finishing 37ms :: begin 2017-09-15T07:50:47.915Z :: end 2017-09-15T07:50:48.013Z
2017-09-15 07:50:48 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD>11
[31m- test the result for short datatype in clause where field is null *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:393)[0m
Sep 15, 2017 7:50:48 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075048_00030_b6j96 :: Transaction:[b3a3cfad-a84d-4a08-b79d-c33eff079e13] :: elapsed 45ms :: planning 28ms :: scheduling 17ms :: running 0ms :: finishing 17ms :: begin 2017-09-15T07:50:48.025Z :: end 2017-09-15T07:50:48.070Z
Sep 15, 2017 7:50:48 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_075048_00031_b6j96 :: Transaction:[fee37ee0-31b5-467c-b07c-8d4b2f86ca00] :: elapsed 39ms :: planning 23ms :: scheduling 16ms :: running 0ms :: finishing 16ms :: begin 2017-09-15T07:50:48.084Z :: end 2017-09-15T07:50:48.123Z
[31m- test the result for short datatype with greater than operator *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:401)[0m
Sep 15, 2017 7:50:48 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 7:50:48 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4ef277ef{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:8086}
Sep 15, 2017 7:50:49 AM io.airlift.log.Logger warn
WARNING: Error fetching memory info from http://127.0.0.1:8086/v1/memory: Server refused connection: http://127.0.0.1:8086/v1/memory
Sep 15, 2017 7:50:51 AM io.airlift.log.Logger warn
WARNING: Error fetching node state from http://127.0.0.1:8086/v1/info/state: Server refused connection: http://127.0.0.1:8086/v1/info/state
2017-09-15 07:50:51 INFO AbstractDataLoadProcessorStep:150 - Thread-2 Rows processed in step Data Writer : 10
2017-09-15 07:50:51 INFO AbstractDataLoadProcessorStep:150 - Thread-3 Rows processed in step Data Converter : 10
2017-09-15 07:50:51 INFO AbstractDataLoadProcessorStep:150 - Thread-4 Rows processed in step Input Processor : 10
Sep 15, 2017 7:50:51 AM io.airlift.log.Logger warn
WARNING: Error fetching memory info from http://127.0.0.1:8086/v1/memory: Server refused connection: http://127.0.0.1:8086/v1/memory
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@2c51c756{/,null,UNAVAILABLE,@http}
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=11,q=12} Couldn't stop Thread[http-worker-374,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=5,q=11} Couldn't stop Thread[http-worker-209,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=2,q=11} Couldn't stop Thread[http-worker-211,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=0,q=10} Couldn't stop Thread[http-worker-303,5,]
Sep 15, 2017 7:50:52 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 7:50:52 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@31c0c7e5{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:41350}
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@67f266bd{/,null,UNAVAILABLE,@http}
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=14,q=13} Couldn't stop Thread[http-worker-156,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=9,q=13} Couldn't stop Thread[http-worker-310,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=5,q=12} Couldn't stop Thread[http-worker-417,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=5,q=12} Couldn't stop Thread[http-worker-153,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=4,q=12} Couldn't stop Thread[http-worker-155,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=2,q=12} Couldn't stop Thread[http-worker-309,5,]
Sep 15, 2017 7:50:52 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 7:50:52 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4adcc981{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:46094}
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@729d6ee2{/,null,UNAVAILABLE,@http}
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=10,q=11} Couldn't stop Thread[http-worker-361,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=8,q=11} Couldn't stop Thread[http-worker-116,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=7,q=11} Couldn't stop Thread[http-worker-422,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=3,q=10} Couldn't stop Thread[http-worker-124,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=1,q=9} Couldn't stop Thread[http-worker-377,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=0,q=8} Couldn't stop Thread[http-worker-421,5,]
Sep 15, 2017 7:50:52 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 7:50:52 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@38929da{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:39222}
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@1e6d30c0{/,null,UNAVAILABLE,@http}
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=9,q=10} Couldn't stop Thread[http-worker-424,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=8,q=10} Couldn't stop Thread[http-worker-425,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=7,q=10} Couldn't stop Thread[http-worker-314,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=1,q=10} Couldn't stop Thread[http-worker-316,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=14<=200,i=1,q=10} Couldn't stop Thread[http-worker-423,5,main]
Sep 15, 2017 7:50:52 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 7:50:52 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@7da635c0{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:45671}
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@3d615b2e{/,null,UNAVAILABLE,@http}
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=9,q=9} Couldn't stop Thread[http-worker-416,5,main]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=6,q=9} Couldn't stop Thread[http-worker-45,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=1,q=8} Couldn't stop Thread[http-worker-44,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=1,q=8} Couldn't stop Thread[http-worker-428,5,]
Sep 15, 2017 7:50:52 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=11<=200,i=0,q=8} Couldn't stop Thread[http-worker-427,5,]
Sep 15, 2017 7:50:52 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
2017-09-15 07:50:52 INFO PrestoServer$:88 - ***** Stopping The Server *****
[36mRun completed in 21 seconds, 826 milliseconds.[0m
[36mTotal number of tests run: 32[0m
[36mSuites: completed 2, aborted 0[0m
[36mTests: succeeded 6, failed 26, canceled 0, ignored 0, pending 0[0m
[31m*** 26 TESTS FAILED ***[0m
[JENKINS] Recording test results
Build failed in Jenkins: carbondata-master-spark-2.1 » Apache CarbonData :: presto #1380
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/carbondata-master-spark-2.1/org.apache.carbondata$carbondata-presto/1380/display/redirect>
------------------------------------------
[...truncated 173.64 KB...]
SELECT COUNT(BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for count()clause with distinct operator on decimal column in presto[0m
Sep 15, 2017 4:41:07 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044107_00008_4vd7x :: Transaction:[f6690c9e-e2c4-4125-a7f4-d6de4a37d497] :: elapsed 51ms :: planning 24ms :: scheduling 27ms :: running 0ms :: finishing 27ms :: begin 2017-09-15T04:41:07.108Z :: end 2017-09-15T04:41:07.159Z
[32m- test the result for count()clause with out distinct operator on decimal column in presto[0m
2017-09-15 04:41:07 INFO PrestoServer$:101 - ***** executing the query *****
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
[32m- test the result for sum()with out distinct operator for decimal column in presto[0m
2017-09-15 04:41:07 INFO PrestoServer$:101 - ***** executing the query *****
SELECT SUM(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 4:41:07 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044107_00009_4vd7x :: Transaction:[6e27847c-1570-4a36-ac92-381f0687ce9e] :: elapsed 140ms :: planning 38ms :: scheduling 102ms :: running 0ms :: finishing 102ms :: begin 2017-09-15T04:41:07.173Z :: end 2017-09-15T04:41:07.313Z
2017-09-15 04:41:07 INFO PrestoServer$:101 - ***** executing the query *****
SELECT AVG(DISTINCT BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 4:41:07 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044107_00010_4vd7x :: Transaction:[856627fd-00f2-42e8-b02c-4d76aec8e078] :: elapsed 105ms :: planning 28ms :: scheduling 77ms :: running 0ms :: finishing 77ms :: begin 2017-09-15T04:41:07.328Z :: end 2017-09-15T04:41:07.433Z
[31m- test the result for sum() with distinct operator for decimal column in presto *** FAILED ***[0m
[31m java.lang.NullPointerException:[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply$mcV$sp(PrestoAllDataTypeTest.scala:115)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$11.apply(PrestoAllDataTypeTest.scala:110)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m at org.scalatest.FunSuiteLike$$anon$1.apply(FunSuiteLike.scala:166)[0m
[31m at org.scalatest.Suite$class.withFixture(Suite.scala:1122)[0m
[31m ...[0m
[32m- test the result for avg() with distinct operator on decimal coin presto[0m
2017-09-15 04:41:07 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MIN(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 4:41:07 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044107_00011_4vd7x :: Transaction:[0a77eaff-e688-4698-9eba-19a03f11e16c] :: elapsed 93ms :: planning 37ms :: scheduling 56ms :: running 0ms :: finishing 56ms :: begin 2017-09-15T04:41:07.447Z :: end 2017-09-15T04:41:07.540Z
[32m- test the result for min() with distinct operator in decimalType of presto[0m
Sep 15, 2017 4:41:07 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044107_00012_4vd7x :: Transaction:[97aecad4-9f8d-45a1-8cae-f097081417c0] :: elapsed 85ms :: planning 40ms :: scheduling 45ms :: running 0ms :: finishing 45ms :: begin 2017-09-15T04:41:07.552Z :: end 2017-09-15T04:41:07.637Z
2017-09-15 04:41:07 INFO PrestoServer$:101 - ***** executing the query *****
SELECT MAX(BONUS) AS RESULT FROM TESTDB.TESTTABLE
Sep 15, 2017 4:41:07 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044107_00013_4vd7x :: Transaction:[ac86bba0-46f3-41ca-871a-f533dc7dabd3] :: elapsed 73ms :: planning 34ms :: scheduling 39ms :: running 0ms :: finishing 39ms :: begin 2017-09-15T04:41:07.648Z :: end 2017-09-15T04:41:07.721Z
[32m- test the result for max() with distinct operator in decimalType of presto[0m
2017-09-15 04:41:07 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT BONUS FROM TESTDB.TESTTABLE ORDER BY BONUS limit 3
2017-09-15 04:41:07 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE ORDER BY NAME
[31m- select decimal data type with ORDER BY clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:147)[0m
Sep 15, 2017 4:41:07 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044107_00014_4vd7x :: Transaction:[e4bde44d-d97d-461a-b959-356191c9d4c0] :: elapsed 116ms :: planning 30ms :: scheduling 86ms :: running 0ms :: finishing 86ms :: begin 2017-09-15T04:41:07.747Z :: end 2017-09-15T04:41:07.863Z
2017-09-15 04:41:07 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DATE FROM TESTDB.TESTTABLE ORDER BY DATE
[31m- select string type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:162)[0m
Sep 15, 2017 4:41:07 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044107_00015_4vd7x :: Transaction:[076462c5-41d6-44a4-9c71-0ae6b27bdeb1] :: elapsed 87ms :: planning 38ms :: scheduling 49ms :: running 0ms :: finishing 49ms :: begin 2017-09-15T04:41:07.879Z :: end 2017-09-15T04:41:07.966Z
2017-09-15 04:41:08 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT ID FROM TESTDB.TESTTABLE ORDER BY ID
Sep 15, 2017 4:41:08 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044107_00016_4vd7x :: Transaction:[47f1c877-ba46-4971-b39b-3557053de3c5] :: elapsed 39ms :: planning 23ms :: scheduling 16ms :: running 0ms :: finishing 16ms :: begin 2017-09-15T04:41:07.983Z :: end 2017-09-15T04:41:08.022Z
[31m- select DATE type with order by clause *** FAILED ***[0m
[31m java.util.NoSuchElementException: head of empty list[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:420)[0m
[31m at scala.collection.immutable.Nil$.head(List.scala:417)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply$mcV$sp(PrestoAllDataTypeTest.scala:182)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.apache.carbondata.presto.integrationtest.PrestoAllDataTypeTest$$anonfun$17.apply(PrestoAllDataTypeTest.scala:164)[0m
[31m at org.scalatest.Transformer$$anonfun$apply$1.apply$mcV$sp(Transformer.scala:22)[0m
[31m at org.scalatest.OutcomeOf$class.outcomeOf(OutcomeOf.scala:85)[0m
[31m at org.scalatest.OutcomeOf$.outcomeOf(OutcomeOf.scala:104)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:22)[0m
[31m at org.scalatest.Transformer.apply(Transformer.scala:20)[0m
[31m ...[0m
2017-09-15 04:41:08 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID>2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- select int type with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:197)[0m
Sep 15, 2017 4:41:08 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044108_00017_4vd7x :: Transaction:[ec7585f3-7446-4ba2-8117-4ec4d32ccfe0] :: elapsed 67ms :: planning 25ms :: scheduling 42ms :: running 0ms :: finishing 42ms :: begin 2017-09-15T04:41:08.040Z :: end 2017-09-15T04:41:08.107Z
2017-09-15 04:41:08 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
[31m- test and filter clause with greater than expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:223)[0m
Sep 15, 2017 4:41:08 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044108_00018_4vd7x :: Transaction:[63320172-b80f-43ca-8822-18da0ce8c393] :: elapsed 175ms :: planning 111ms :: scheduling 64ms :: running 0ms :: finishing 64ms :: begin 2017-09-15T04:41:08.147Z :: end 2017-09-15T04:41:08.322Z
[31m- test and filter clause with greater than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:267)[0m
2017-09-15 04:41:08 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS<=1234.444 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID LIMIT 2
Sep 15, 2017 4:41:08 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044108_00019_4vd7x :: Transaction:[5089f224-3c92-4030-a7ab-c8f95e63eb3f] :: elapsed 115ms :: planning 57ms :: scheduling 58ms :: running 0ms :: finishing 58ms :: begin 2017-09-15T04:41:08.349Z :: end 2017-09-15T04:41:08.464Z
[31m- test and filter clause with less than equal to expression *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:292)[0m
2017-09-15 04:41:08 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE BONUS=1234.444
Sep 15, 2017 4:41:08 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044108_00020_4vd7x :: Transaction:[2e795869-98b3-42bc-9ea4-a3503d2e0d32] :: elapsed 124ms :: planning 43ms :: scheduling 81ms :: running 0ms :: finishing 81ms :: begin 2017-09-15T04:41:08.487Z :: end 2017-09-15T04:41:08.611Z
Sep 15, 2017 4:41:08 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044108_00021_4vd7x :: Transaction:[1570afc0-89ec-4b4e-b172-67112bf9dc97] :: elapsed 61ms :: planning 37ms :: scheduling 24ms :: running 0ms :: finishing 24ms :: begin 2017-09-15T04:41:08.627Z :: end 2017-09-15T04:41:08.688Z
[31m- test equal to expression on decimal value *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:301)[0m
2017-09-15 04:41:08 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS FROM TESTDB.TESTTABLE WHERE BONUS>1234 AND ID<2 GROUP BY ID,DATE,COUNTRY,NAME,PHONETYPE,SERIALNAME,SALARY,BONUS ORDER BY ID
2017-09-15 04:41:08 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE IN('phone1848','phone706')
[31m- test less than expression with and operator *** FAILED ***[0m
[31m actualResult.toString().equals(expectedResult.toString()) was false (PrestoAllDataTypeTest.scala:317)[0m
Sep 15, 2017 4:41:08 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044108_00022_4vd7x :: Transaction:[ad5261dd-b0a2-4544-933e-d03940f375f8] :: elapsed 152ms :: planning 73ms :: scheduling 79ms :: running 0ms :: finishing 79ms :: begin 2017-09-15T04:41:08.707Z :: end 2017-09-15T04:41:08.859Z
[31m- test the result for in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:327)[0m
2017-09-15 04:41:09 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME from testdb.testtable WHERE PHONETYPE NOT IN('phone1848','phone706')
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044108_00023_4vd7x :: Transaction:[d5a6ed47-c5c5-4918-9e97-8c51917d6c2b] :: elapsed 380ms :: planning 358ms :: scheduling 22ms :: running 0ms :: finishing 22ms :: begin 2017-09-15T04:41:08.879Z :: end 2017-09-15T04:41:09.259Z
[31m- test the result for not in clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:341)[0m
2017-09-15 04:41:09 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID FROM TESTDB.TESTTABLE WHERE DATE IS NULL
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044109_00024_4vd7x :: Transaction:[caea12d5-348a-45b0-a7cf-122eea40fc1e] :: elapsed 73ms :: planning 54ms :: scheduling 19ms :: running 0ms :: finishing 19ms :: begin 2017-09-15T04:41:09.274Z :: end 2017-09-15T04:41:09.347Z
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044109_00025_4vd7x :: Transaction:[44e13a33-699e-4b60-8c9e-22a171746922] :: elapsed 53ms :: planning 27ms :: scheduling 26ms :: running 0ms :: finishing 26ms :: begin 2017-09-15T04:41:09.367Z :: end 2017-09-15T04:41:09.420Z
2017-09-15 04:41:09 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DATE IS NOT NULL AND ID=9
[31m- test for null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:347)[0m
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044109_00026_4vd7x :: Transaction:[ff396614-1d19-4a46-bf7a-ffd099ee2d9d] :: elapsed 72ms :: planning 58ms :: scheduling 14ms :: running 0ms :: finishing 14ms :: begin 2017-09-15T04:41:09.432Z :: end 2017-09-15T04:41:09.504Z
[31m- test for not null operator on date data type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:354)[0m
2017-09-15 04:41:09 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NOT NULL AND ID=9
[31m- test for not null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:362)[0m
2017-09-15 04:41:09 INFO PrestoServer$:101 - ***** executing the query *****
SELECT NAME FROM TESTDB.TESTTABLE WHERE DOB IS NULL AND ID=1
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044109_00027_4vd7x :: Transaction:[9688c0bb-9143-4a43-9915-868dc0e702ae] :: elapsed 47ms :: planning 34ms :: scheduling 13ms :: running 0ms :: finishing 13ms :: begin 2017-09-15T04:41:09.518Z :: end 2017-09-15T04:41:09.565Z
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044109_00028_4vd7x :: Transaction:[b8904b01-663a-4409-b573-a9f6b5adccdf] :: elapsed 46ms :: planning 29ms :: scheduling 17ms :: running 0ms :: finishing 17ms :: begin 2017-09-15T04:41:09.578Z :: end 2017-09-15T04:41:09.624Z
[31m- test for null operator on timestamp type *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:369)[0m
2017-09-15 04:41:09 INFO PrestoServer$:101 - ***** executing the query *****
SELECT DISTINCT SHORTFIELD from testdb.testtable ORDER BY SHORTFIELD
[31m- test the result for short datatype with order by clause *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:385)[0m
2017-09-15 04:41:09 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD IS NULL ORDER BY SHORTFIELD
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044109_00029_4vd7x :: Transaction:[c059bf41-2fff-4e24-a3d5-978b1a5cd2f0] :: elapsed 132ms :: planning 25ms :: scheduling 107ms :: running 0ms :: finishing 107ms :: begin 2017-09-15T04:41:09.640Z :: end 2017-09-15T04:41:09.772Z
[31m- test the result for short datatype in clause where field is null *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:393)[0m
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044109_00030_4vd7x :: Transaction:[cfe360eb-8b04-4209-b9e0-af313efeb92b] :: elapsed 44ms :: planning 30ms :: scheduling 14ms :: running 0ms :: finishing 14ms :: begin 2017-09-15T04:41:09.784Z :: end 2017-09-15T04:41:09.828Z
2017-09-15 04:41:09 INFO PrestoServer$:101 - ***** executing the query *****
SELECT ID from testdb.testtable WHERE SHORTFIELD>11
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: TIMELINE: Query 20170915_044109_00031_4vd7x :: Transaction:[22c1ac41-3fd9-4887-9fe3-a07f79626501] :: elapsed 46ms :: planning 32ms :: scheduling 14ms :: running 0ms :: finishing 14ms :: begin 2017-09-15T04:41:09.840Z :: end 2017-09-15T04:41:09.886Z
[31m- test the result for short datatype with greater than operator *** FAILED ***[0m
[31m actualResult.equals(expectedResult) was false (PrestoAllDataTypeTest.scala:401)[0m
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4ef277ef{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:8086}
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@2c51c756{/,null,UNAVAILABLE,@http}
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=11,q=11} Couldn't stop Thread[http-worker-354,5,main]
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=8,q=11} Couldn't stop Thread[http-worker-211,5,]
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=4,q=10} Couldn't stop Thread[http-worker-378,5,]
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=16<=200,i=0,q=10} Couldn't stop Thread[http-worker-379,5,]
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@31c0c7e5{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:44323}
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@67f266bd{/,null,UNAVAILABLE,@http}
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=12<=200,i=10,q=9} Couldn't stop Thread[http-worker-400,5,]
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=12<=200,i=2,q=9} Couldn't stop Thread[http-worker-153,5,]
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=12<=200,i=0,q=8} Couldn't stop Thread[http-worker-408,5,]
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@4adcc981{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:42032}
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@729d6ee2{/,null,UNAVAILABLE,@http}
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=11,q=10} Couldn't stop Thread[http-worker-412,5,main]
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=6,q=10} Couldn't stop Thread[http-worker-304,5,]
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=0,q=7} Couldn't stop Thread[http-worker-411,5,]
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 4:41:09 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 4:41:09 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@38929da{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:44569}
2017-09-15 04:41:12 INFO AbstractDataLoadProcessorStep:150 - Thread-4 Rows processed in step Input Processor : 10
2017-09-15 04:41:12 INFO AbstractDataLoadProcessorStep:150 - Thread-2 Rows processed in step Data Writer : 10
2017-09-15 04:41:12 INFO AbstractDataLoadProcessorStep:150 - Thread-3 Rows processed in step Data Converter : 10
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@1e6d30c0{/,null,UNAVAILABLE,@http}
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=10,q=11} Couldn't stop Thread[http-worker-415,5,main]
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=3,q=10} Couldn't stop Thread[http-worker-353,5,]
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=2,q=9} Couldn't stop Thread[http-worker-403,5,]
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=13<=200,i=2,q=9} Couldn't stop Thread[http-worker-414,5,main]
Sep 15, 2017 4:41:14 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
Sep 15, 2017 4:41:14 AM io.airlift.log.Logger info
INFO: Life cycle stopping...
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.server.AbstractConnector doStop
INFO: Stopped http@7da635c0{HTTP/1.1,[http/1.1, h2c, h2c-17, h2c-16, h2c-15, h2c-14]}{127.0.0.1:34502}
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.server.handler.ContextHandler doStop
INFO: Stopped o.e.j.s.ServletContextHandler@3d615b2e{/,null,UNAVAILABLE,@http}
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=8,q=8} Couldn't stop Thread[http-worker-416,5,main]
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=6,q=7} Couldn't stop Thread[http-worker-45,5,main]
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=5,q=7} Couldn't stop Thread[http-worker-43,5,main]
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=2,q=7} Couldn't stop Thread[http-worker-417,5,main]
Sep 15, 2017 4:41:14 AM org.eclipse.jetty.util.thread.QueuedThreadPool doStop
WARNING: http-worker{STOPPING,2<=10<=200,i=2,q=7} Couldn't stop Thread[http-worker-418,5,main]
Sep 15, 2017 4:41:14 AM io.airlift.log.Logger info
INFO: Life cycle stopped.
2017-09-15 04:41:14 INFO PrestoServer$:88 - ***** Stopping The Server *****
[36mRun completed in 22 seconds, 950 milliseconds.[0m
[36mTotal number of tests run: 32[0m
[36mSuites: completed 2, aborted 0[0m
[36mTests: succeeded 6, failed 26, canceled 0, ignored 0, pending 0[0m
[31m*** 26 TESTS FAILED ***[0m
[JENKINS] Recording test results