See <https://ci.trafficserver.apache.org/job/tsqa-master/825/changes>
Changes: [Thomas Jackson] Correct docs for timing fields [Thomas Jackson] Correctly raise SkipTest if hyper is not present [Thomas Jackson] tsqa test cases: Pylint cleanup ------------------------------------------ [...truncated 508 lines...] INFO 2015-08-29 01:49:24,787 - Environment prefix is /tmp/tsqa.env.pGUkET test_spdy (test_example.TestConfigureFlags) ... ok INFO 2015-08-29 01:49:28,189 - Environment prefix is /tmp/tsqa.env.3xwoZu test_basic_proxy (test_example.TestDynamicHTTPEndpointCase) ... 127.0.0.1 - - [29/Aug/2015 01:49:31] "GET /test HTTP/1.1" 404 0 ok INFO 2015-08-29 01:49:31,620 - Environment prefix is /tmp/tsqa.env.8Apf8L test_logs_exist (test_example.TestLogRefCounting) ... 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 127.0.0.1 - - [29/Aug/2015 01:49:34] "GET / HTTP/1.1" 404 0 FAIL INFO 2015-08-29 01:49:45,131 - Environment prefix is /tmp/tsqa.env.Ss_8ys test_logs_exist (test_example.TestLogs) ... ok SKIP: Skip the entire class INFO 2015-08-29 01:49:58,595 - Environment prefix is /tmp/tsqa.env.VLHYnw test_basic_intercept (test_example.TestServerIntercept) ... 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:01] "GET / HTTP/1.1" 200 5 ok INFO 2015-08-29 01:50:02,080 - Environment prefix is /tmp/tsqa.env.8tovYV INFO 2015-08-29 01:50:02,083 - map / http://127.0.0.1:52174/ test_head_request_without_timout (test_headrequest.TestHeadRequestWithoutTimeout) ... INFO 2015-08-29 01:50:05,319 - HTTP/1.1 200 OK Server: ATS/6.1.0 Vary: Accept-Encoding Date: Sat, 29 Aug 2015 01:50:05 GMT Age: 0 Connection: close INFO 2015-08-29 01:50:05,319 - head request with case(TE) costs 0.006321 seconds while the timout is 5.000000 seconds. INFO 2015-08-29 01:50:05,320 - HTTP/1.1 200 OK Server: ATS/6.1.0 Content-Length: 123 Vary: Accept-Encoding Date: Sat, 29 Aug 2015 01:50:05 GMT Age: 0 Connection: close INFO 2015-08-29 01:50:05,320 - head request with case(CL) costs 0.000761 seconds while the timout is 5.000000 seconds. INFO 2015-08-29 01:50:05,331 - HTTP/1.1 200 OK Server: ATS/6.1.0 Vary: Accept-Encoding Date: Sat, 29 Aug 2015 01:50:05 GMT Age: 0 Connection: close INFO 2015-08-29 01:50:05,332 - head request with case() costs 0.011573 seconds while the timout is 5.000000 seconds. ok INFO 2015-08-29 01:50:05,514 - Environment prefix is /tmp/tsqa.env.7oY0ND test_working (test_hostdb.TestHostDBBadResolvConf) ... ok INFO 2015-08-29 01:50:08,973 - Environment prefix is /tmp/tsqa.env.qbd6pO test_lookup_timeout (test_hostdb.TestHostDBFailedDNS) ... ok INFO 2015-08-29 01:50:14,504 - Environment prefix is /tmp/tsqa.env.x4Fnmf Test basic fnctionality of hosts files ... ok Test that changes to hosts file get loaded within host_file.interval ... ok INFO 2015-08-29 01:50:24,014 - Environment prefix is /tmp/tsqa.env.RkRYHb SKIP: -------------------- >> begin captured logging << -------------------- root: INFO: Environment prefix is /tmp/tsqa.env.RkRYHb --------------------- >> end captured logging << --------------------- Failure: SkipTest (Cannot import hyper, skipping tests for HTTP/2) ... SKIP: Cannot import hyper, skipping tests for HTTP/2 INFO 2015-08-29 01:50:24,115 - Environment prefix is /tmp/tsqa.env.oH9bKi test_ecdsa (test_https.TestECDSA) ... ok test_intermediate_ca_ecdsa (test_https.TestECDSA) ... ok test_intermediate_ca_rsa (test_https.TestECDSA) ... ok We should be served the first match, since we aren't sending SNI headers ... ok Make sure we get the certificate we asked for if we pass in SNI headers ... ok test_rsa (test_https.TestECDSA) ... ok We should be served the first match, since we aren't sending SNI headers ... ok Make sure we get the certificate we asked for if we pass in SNI headers ... ok INFO 2015-08-29 01:50:27,634 - Environment prefix is /tmp/tsqa.env.Tf4wEK test_ecdsa (test_https.TestMix) ... ok test_intermediate_ca_ecdsa (test_https.TestMix) ... ok test_intermediate_ca_rsa (test_https.TestMix) ... ok We should be served the first match, since we aren't sending SNI headers ... ok Make sure we get the certificate we asked for if we pass in SNI headers ... ok test_rsa (test_https.TestMix) ... ok We should be served the first match, since we aren't sending SNI headers ... ok Make sure we get the certificate we asked for if we pass in SNI headers ... ok INFO 2015-08-29 01:50:31,205 - Environment prefix is /tmp/tsqa.env.h07kKl test_ecdsa (test_https.TestRSA) ... ok test_intermediate_ca_ecdsa (test_https.TestRSA) ... ok test_intermediate_ca_rsa (test_https.TestRSA) ... ok We should be served the first match, since we aren't sending SNI headers ... ok Make sure we get the certificate we asked for if we pass in SNI headers ... ok test_rsa (test_https.TestRSA) ... ok We should be served the first match, since we aren't sending SNI headers ... ok Make sure we get the certificate we asked for if we pass in SNI headers ... ok INFO 2015-08-29 01:50:34,755 - Environment prefix is /tmp/tsqa.env.5hR1dK test_error_path (test_keepalive.TestKeepAliveInHTTP) ... ok Ensure that sending a request with a body doesn't break the keepalive session ... ok test_working_path (test_keepalive.TestKeepAliveInHTTP) ... 127.0.0.1 - - [29/Aug/2015 01:50:37] "GET /exists/ HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:37] "GET /exists/ HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:37] "GET /exists/ HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:37] "GET /exists/ HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:37] "GET /exists/ HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:37] "GET /exists/ HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:37] "GET /exists/ HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:37] "GET /exists/ HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:50:37] "GET /exists/ HTTP/1.1" 200 5 ok INFO 2015-08-29 01:50:38,175 - Environment prefix is /tmp/tsqa.env.OeGGkM Tests that origin_min_keep_alive_connections is honored via http. ... ok INFO 2015-08-29 01:50:44,605 - Environment prefix is /tmp/tsqa.env.iXKmHO Tests that origin_min_keep_alive_connections is honored via https. ... ok INFO 2015-08-29 01:50:51,027 - Environment prefix is /tmp/tsqa.env.AaVipM Test that the origin does in fact support keepalive via http. ... ok Tests that keepalive works through ATS to origin via http. ... ok Tests that origin does not timeout using keepalive via http. ... ok Tests that keepalive timeout is honored through ATS to origin via http. ... ok INFO 2015-08-29 01:51:12,556 - Environment prefix is /tmp/tsqa.env.bNYJNl Test that the origin does in fact support keepalive via https. ... ok Tests that keepalive works through ATS to origin via https. ... ok Tests that origin does not timeout using keepalive via https. ... ok Tests that keepalive timeout is honored through ATS to origin via https. ... ok INFO 2015-08-29 01:51:34,056 - Environment prefix is /tmp/tsqa.env.RvwRCv Tests that keepalive works through ATS to origin via https. ... ok Tests that keepalive works through ATS to origin via https. ... ok INFO 2015-08-29 01:51:37,500 - Environment prefix is /tmp/tsqa.env.urz2mr Tests that keepalive works through ATS to origin via https. ... ok Tests that keepalive works through ATS to origin via https. ... ok INFO 2015-08-29 01:51:40,924 - Environment prefix is /tmp/tsqa.env.GYA5mU INFO 2015-08-29 01:51:40,926 - socket_server_port = 48720 INFO 2015-08-29 01:51:40,927 - starting the socket server test_origin_min_connection (test_origin_min_keep_alive_connection.TestKeepAlive_Origin_Min_connections) ... INFO 2015-08-29 01:51:44,173 - Sending data back to the client: 3ce1dee55f7d49b294c502ea28e841a2 INFO 2015-08-29 01:51:44,174 - 3ce1dee55f7d49b294c502ea28e841a2 INFO 2015-08-29 01:51:49,180 - Sending data back to the client: 3ce1dee55f7d49b294c502ea28e841a2 INFO 2015-08-29 01:51:49,181 - 3ce1dee55f7d49b294c502ea28e841a2 ok INFO 2015-08-29 01:51:49,362 - Environment prefix is /tmp/tsqa.env.YIXlti test_redirection (test_redirection.TestRedirection) ... 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/9 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/8 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/7 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/6 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/5 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/4 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/3 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/2 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/1 HTTP/1.1" 302 215 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /get HTTP/1.1" 200 437 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/10 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/9 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/8 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/7 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/6 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/5 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/4 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/3 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/2 HTTP/1.1" 302 229 127.0.0.1 - - [29/Aug/2015 01:51:52] "GET /redirect/1 HTTP/1.1" 302 215 ok INFO 2015-08-29 01:51:52,904 - Environment prefix is /tmp/tsqa.env.bMFQ9l test_regressions (test_regressions.TestRegressions) ... ok INFO 2015-08-29 01:54:26,124 - Starting build (d133993325226bee52737bbab4e1cbc1): configure {'enable-ccache': None, 'enable-experimental-plugins': None, 'enable-example-plugins': None, 'enable-test-tools': None, 'enable-linux-native-aio': None, 'disable-dependency-tracking': None} SKIP: Error 1 running: ['<https://ci.trafficserver.apache.org/job/tsqa-master/ws/src/configure',> '--prefix=/', '--enable-ccache', '--enable-experimental-plugins', '--enable-example-plugins', '--enable-test-tools', '--enable-linux-native-aio', '--disable-dependency-tracking'] configure: error: Linux native AIO requires libaio.h -------------------- >> begin captured logging << -------------------- tsqa.environment: INFO: Starting build (d133993325226bee52737bbab4e1cbc1): configure {'enable-ccache': None, 'enable-experimental-plugins': None, 'enable-example-plugins': None, 'enable-test-tools': None, 'enable-linux-native-aio': None, 'disable-dependency-tracking': None} --------------------- >> end captured logging << --------------------- INFO 2015-08-29 01:54:35,384 - Environment prefix is /tmp/tsqa.env.Eh7VeH test_remap_http (test_remap.TestRemapHTTP) ... 127.0.0.1 - - [29/Aug/2015 01:54:38] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:54:38] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:54:38] "GET / HTTP/1.1" 200 5 ok INFO 2015-08-29 01:54:38,913 - Environment prefix is /tmp/tsqa.env.UoMDzq test_remap_https (test_remap.TestRemapHTTPS) ... 127.0.0.1 - - [29/Aug/2015 01:54:42] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:54:42] "GET / HTTP/1.1" 200 5 127.0.0.1 - - [29/Aug/2015 01:54:42] "GET / HTTP/1.1" 200 5 ok SKIP: Skipping spdy/2 tests INFO 2015-08-29 01:54:42,467 - Environment prefix is /tmp/tsqa.env.RPNuu7 INFO 2015-08-29 01:54:42,469 - spdycat path = /usr/local/bin/spdycat INFO 2015-08-29 01:54:42,469 - spdy server port = 34210 INFO 2015-08-29 01:54:42,469 - http server port = 39234 Test that the origin does in fact support spdy 3 ... INFO 2015-08-29 01:54:45,703 - full args = ['/usr/local/bin/spdycat', 'https://localhost:34210/', '-nv', '--spdy3'] ok Test that non spdy port won't advertise spdy ... INFO 2015-08-29 01:54:46,946 - full args = ['/usr/local/bin/spdycat', 'https://localhost:39234/', '-nv', '--spdy3'] Fatal: EOF reqnum=1, completed=0 Some requests were not processed. total=1, processed=0 ok INFO 2015-08-29 01:54:47,157 - Environment prefix is /tmp/tsqa.env.f1CoHt INFO 2015-08-29 01:54:47,159 - spdycat path = /usr/local/bin/spdycat INFO 2015-08-29 01:54:47,159 - spdy server port = 51989 INFO 2015-08-29 01:54:47,159 - http server port = 54756 Test that the origin does in fact support spdy 3.1 ... INFO 2015-08-29 01:54:50,362 - full args = ['/usr/local/bin/spdycat', 'https://localhost:51989/', '-nv', '--spdy3-1'] ok Test that non spdy port won't advertise spdy ... INFO 2015-08-29 01:54:51,546 - full args = ['/usr/local/bin/spdycat', 'https://localhost:54756/', '-nv', '--spdy3-1'] Fatal: EOF reqnum=1, completed=0 Some requests were not processed. total=1, processed=0 ok INFO 2015-08-29 01:54:51,773 - Environment prefix is /tmp/tsqa.env.Bgfdfw Make sure the new ticket key is loaded ... ok Make sure the new ticket key is loaded ... ok ====================================================================== FAIL: Verify that we get 504s from origins that return a partial_response ---------------------------------------------------------------------- Traceback (most recent call last): File "<https://ci.trafficserver.apache.org/job/tsqa-master/ws/src/ci/tsqa/tests/test_connect_attempts.py";,> line 195, in test_partial_response_origin self.assertEqual(ret.status_code, 502) AssertionError: 200 != 502 ====================================================================== FAIL: Verify that we get 200s from origins that reset_after_accept ---------------------------------------------------------------------- Traceback (most recent call last): File "<https://ci.trafficserver.apache.org/job/tsqa-master/ws/src/ci/tsqa/tests/test_connect_attempts.py";,> line 201, in test_reset_after_accept_origin self.assertEqual(ret.status_code, 200) AssertionError: 502 != 200 ====================================================================== FAIL: test_logs_exist (test_example.TestLogRefCounting) ---------------------------------------------------------------------- Traceback (most recent call last): File "<https://ci.trafficserver.apache.org/job/tsqa-master/ws/src/ci/tsqa/tests/test_example.py";,> line 215, in test_logs_exist self.assertTrue(os.path.isfile(logfile_path), logfile_path) AssertionError: /tmp/tsqa.env.8Apf8L/var/log/squid.log -------------------- >> begin captured logging << -------------------- root: INFO: Environment prefix is /tmp/tsqa.env.8Apf8L --------------------- >> end captured logging << --------------------- ---------------------------------------------------------------------- XML: <https://ci.trafficserver.apache.org/job/tsqa-master/ws/src/ci/tsqa/nosetests.xml> ---------------------------------------------------------------------- Ran 84 tests in 925.120s FAILED (SKIP=7, failures=3) 2 make: *** [test] Error 1 Build step 'Execute shell' marked build as failure Recording test results
