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/15 08:51:36 UTC
Build failed in Jenkins: carbondata-master-spark-2.1 » Apache CarbonData :: presto #1383
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
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