Back to build
Raw log | Switch to full mode | Login

Set PYTHONPATH: /b/s/w/ir/kitchen-checkout/build/scripts:/b/s/w/ir/kitchen-checkout/build/site_config:/b/s/w/ir/kitchen-checkout/build/third_party:/b/s/w/ir/kitchen-checkout/build/third_party/buildbot_8_4p1:/b/s/w/ir/kitchen-checkout/build/third_party/buildbot_slave_8_4:/b/s/w/ir/kitchen-checkout/build/third_party/coverage-3.7.1:/b/s/w/ir/kitchen-checkout/build/third_party/decorator_3_3_1:/b/s/w/ir/kitchen-checkout/build/third_party/google_api_python_client:/b/s/w/ir/kitchen-checkout/build/third_party/httplib2/python2:/b/s/w/ir/kitchen-checkout/build/third_party/infra_libs:/b/s/w/ir/kitchen-checkout/build/third_party/jinja2:/b/s/w/ir/kitchen-checkout/build/third_party/markupsafe:/b/s/w/ir/kitchen-checkout/build/third_party/oauth2client:/b/s/w/ir/kitchen-checkout/build/third_party/pyasn1:/b/s/w/ir/kitchen-checkout/build/third_party/pyasn1-modules:/b/s/w/ir/kitchen-checkout/build/third_party/python-rsa:/b/s/w/ir/kitchen-checkout/build/third_party/requests_2_10_0:/b/s/w/ir/kitchen-checkout/build/third_party/setuptools-0.6c11:/b/s/w/ir/kitchen-checkout/build/third_party/sqlalchemy_0_7_1:/b/s/w/ir/kitchen-checkout/build/third_party/sqlalchemy_migrate_0_7_1:/b/s/w/ir/kitchen-checkout/build/third_party/tempita_0_5:/b/s/w/ir/kitchen-checkout/build/third_party/twisted_10_2:/b/s/w/ir/kitchen-checkout/build/third_party/uritemplate:/b/s/w/ir/kitchen-checkout/build/third_party/site-packages 2019-05-21 11:44:41,020 - root: [DEBUG] Using task_output_dir: '/b/s/w/ir/tmp/t/tmp1JEztY' 2019-05-21 11:44:41,021 - root: [WARNING] task_output_dir '/b/s/w/ir/tmp/t/tmp1JEztY' already exists! 2019-05-21 11:44:41,021 - root: [WARNING] task_output_dir existing content: [] 2019-05-21 11:44:41,021 - root: [INFO] collect_cmd: swarming collect -server https://chromium-swarm.appspot.com -worker 50 -task-summary-python -task-output-stdout all -verbose -requests-json /b/s/w/ir/tmp/t/tmp3SBrty.json -output-dir /b/s/w/ir/tmp/t/tmp1JEztY -task-summary-json /b/s/w/ir/tmp/t/tmpHCAyv_.json [D2019-05-21T11:44:41.031041-07:00 30960 0 auth.go:1265] Minting a new token {"key":"luci_ctx/c14f83fba83945609e27b977766e2aad0821bc2968ef0a2f1e0357617d7f0a2e", "scopes":"https://www.googleapis.com/auth/userinfo.email"} [D2019-05-21T11:44:41.031115-07:00 30960 0 luci_ctx.go:138] POST http://127.0.0.1:43743/rpc/LuciLocalAuthService.GetOAuthToken {"key":"luci_ctx/c14f83fba83945609e27b977766e2aad0821bc2968ef0a2f1e0357617d7f0a2e", "scopes":"https://www.googleapis.com/auth/userinfo.email"} [D2019-05-21T11:44:41.033093-07:00 30960 0 auth.go:1222] Token expires in 28m41.966949929s {"key":"luci_ctx/c14f83fba83945609e27b977766e2aad0821bc2968ef0a2f1e0357617d7f0a2e", "scopes":"https://www.googleapis.com/auth/userinfo.email"} [D2019-05-21T11:44:42.343271-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:43.726137-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:44.929044-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:46.180164-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:47.517118-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:48.920086-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:50.306761-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:54.517497-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:56.205133-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:57.874705-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:44:59.593212-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:04.236245-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:06.115558-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:08.093842-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:10.243804-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:12.424108-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:14.631612-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:16.869005-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:19.204954-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:21.618132-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:24.076464-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:27.088252-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:29.818518-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:32.580483-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:35.439141-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:38.653002-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:41.754363-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:44.877191-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:48.109012-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:51.477997-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:55.042252-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:45:59.200755-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:02.893598-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:06.753841-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:10.742771-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:14.899643-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:19.327724-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:24.363649-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:28.911092-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:33.691711-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:39.242749-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:44.830204-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:50.149122-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:46:56.150858-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:47:02.073205-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:47:08.600078-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:47:15.077341-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:47:21.474009-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:47:28.000017-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:47:34.740381-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:47:42.679157-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:47:49.835125-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:47:57.409334-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:48:05.103576-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:48:12.991302-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:48:21.258364-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:48:29.735996-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:48:38.659738-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:48:47.685005-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:48:57.224613-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:49:07.122473-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:49:17.604688-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:49:28.378831-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:49:39.305517-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:49:50.388847-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:50:01.860013-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:50:13.692604-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:50:26.266062-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:50:39.033221-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:50:52.197633-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:51:05.690719-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:51:19.747714-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:51:35.236054-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:51:50.236472-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:52:05.823661-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:52:20.966053-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:52:36.178136-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:52:51.260288-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:53:06.385857-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:53:21.588792-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:53:36.991345-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:53:52.252222-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:54:07.563949-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:54:22.724091-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:54:37.871518-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:54:53.034116-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:55:08.260202-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:55:23.748269-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:55:38.902950-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:55:54.087670-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:56:09.203945-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:56:24.998501-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:56:40.174202-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:56:55.700349-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:57:11.085116-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:57:26.374578-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:57:41.503412-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:57:56.625190-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:58:11.718655-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:58:26.885756-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:58:42.062334-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:58:57.170031-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:59:12.317758-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:59:27.457427-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:59:43.938926-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T11:59:59.100979-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:00:14.614021-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:00:29.910804-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:00:45.062110-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:01:00.240446-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:01:16.463377-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:01:31.792721-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:01:46.903477-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:02:02.530958-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:02:19.901960-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:02:35.293903-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:02:50.507770-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:03:05.643566-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:03:21.066761-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:03:37.314778-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:03:52.451720-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:04:07.831017-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:04:23.073916-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:04:38.345801-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:04:53.563467-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:05:08.822326-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:05:23.954075-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:05:39.204034-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:05:54.305873-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:06:09.456919-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:06:24.660352-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:06:40.463544-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:06:55.679382-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:07:10.798372-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:07:26.665765-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:07:41.798967-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:07:57.112566-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:08:12.346001-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:08:27.558459-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:08:42.801846-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:08:57.936011-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:09:13.602903-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:09:29.610448-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:09:45.080866-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:10:00.214850-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:10:15.417540-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:10:30.601821-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:10:45.716272-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:11:01.260587-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:11:01.261225-07:00 30960 0 auth.go:1274] Refreshing the token {"key":"luci_ctx/c14f83fba83945609e27b977766e2aad0821bc2968ef0a2f1e0357617d7f0a2e", "scopes":"https://www.googleapis.com/auth/userinfo.email"} [D2019-05-21T12:11:01.261648-07:00 30960 0 luci_ctx.go:138] POST http://127.0.0.1:43743/rpc/LuciLocalAuthService.GetOAuthToken {"key":"luci_ctx/c14f83fba83945609e27b977766e2aad0821bc2968ef0a2f1e0357617d7f0a2e", "scopes":"https://www.googleapis.com/auth/userinfo.email"} [D2019-05-21T12:11:02.036601-07:00 30960 0 auth.go:1222] Token expires in 57m36.963436635s {"key":"luci_ctx/c14f83fba83945609e27b977766e2aad0821bc2968ef0a2f1e0357617d7f0a2e", "scopes":"https://www.googleapis.com/auth/userinfo.email"} [D2019-05-21T12:11:17.138197-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:11:32.261611-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:11:47.399234-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:12:02.694409-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:12:17.950026-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:12:33.128533-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:12:48.213084-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:13:03.307545-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:13:18.480851-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:13:33.594352-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 [D2019-05-21T12:13:48.855264-07:00 30960 0 collect.go:311] Waiting task_id: 44f486ec44c6c610 44f486ec44c6c610: exit 0 /b/swarming/swarming_bot.2.zip/third_party/requests/__init__.py:83: RequestsDependencyWarning: Old version of cryptography ([1, 2, 3]) may cause slowdown. tools/testing/dart/main.dart:1: Warning: Interpreting this as package URI, 'package:test_dart/main.dart'. Test configurations: dartkp-android-release-arm(architecture: arm, compiler: dartkp, mode: release, runtime: dart_precompiled, system: android, vm-options: [], dart2js-options: [], timeout: null, preview-dart-2, use-blobs) Suites tested: samples, standalone, standalone_2, corelib_2, language_2, vm, benchmark_smoke, utils, lib_2, analyze_library, service, kernel, ffi dartkp-android-release-arm(architecture: arm, compiler: dartkp, mode: release, runtime: dart_precompiled, system: android, vm-options: [], dart2js-options: [], timeout: null, preview-dart-2, use-blobs) Suites tested: observatory_ui Found 1 Android devices. Total: 862 tests * 81 tests will be skipped (64 skipped by design) * 4 tests are expected to be flaky but not crash * 0 tests are expected to flaky crash * 768 tests are expected to pass * 0 tests are expected to fail that we won't fix * 8 tests are expected to fail that we should fix * 0 tests are expected to crash that we should fix * 0 tests are allowed to timeout * 1 could not be categorized or are in multiple categories 82 out of 781 completed Tests running for 5 minutes FAILED: dartkp-dart_precompiled release_arm language_2/const_map2_test/00 Expected: MissingCompileTimeError Actual: Pass Missing expected compile error. --- Command "vm_compile_to_kernel []" (took 365ms): DART_CONFIGURATION=ReleaseAndroidARM /b/swarming/w/ir/pkg/vm/tool/gen_kernel --aot --platform=out/ReleaseAndroidARM/vm_platform_strong.dill -o /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/multitest_language_2_const_map2_test_00/out.dill /b/swarming/w/ir/out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart --packages=/b/swarming/w/ir/.packages -Ddart.developer.causal_async_stacks=true exit code: 1 stdout: out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart:24:31: Error: The key 'B {}' does not have a primitive operator '=='. - 'B' is from 'out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart'. dynamic m = const {const A(): 42}; ^ out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart:27:34: Error: The key 'B {}' does not have a primitive operator '=='. - 'B' is from 'out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart'. m = const {"foo": 99, const A(): 499}; ^ --- Re-run this test: python tools/test.py -n dartkp-android-release-arm language_2/const_map2_test/00 FAILED: dartkp-dart_precompiled release_arm language_2/function_propagation_test Expected: RuntimeError Actual: Pass --- Command "vm_compile_to_kernel []" (took 01.000277s): DART_CONFIGURATION=ReleaseAndroidARM /b/swarming/w/ir/pkg/vm/tool/gen_kernel --aot --platform=out/ReleaseAndroidARM/vm_platform_strong.dill -o /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.dill /b/swarming/w/ir/tests/language_2/function_propagation_test.dart --packages=/b/swarming/w/ir/.packages -Ddart.developer.causal_async_stacks=true exit code: 0 --- Command "precompiler" (took 03.000348s): DART_CONFIGURATION=ReleaseAndroidARM out/ReleaseAndroidARM/clang_x86/gen_snapshot --snapshot-kind=app-aot-blobs --blobs_container_filename=/b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.aotsnapshot --no-sim-use-hardfp --ignore-unrecognized-flags --packages=/b/swarming/w/ir/.packages /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.dill exit code: 0 --- Command "remove_kernel_file" (took 17ms): DART_CONFIGURATION=ReleaseAndroidARM rm /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.dill exit code: 0 --- Command "adb_precompilation" (took 01.000710s): Steps to push precompiled runner and precompiled code to an attached device. Uses (and requires) adb. exit code: 0 stdout: Executing adb -s 06ab60b3003b6b35 shell rm -Rf /data/local/tmp/precompilation-testing/test ; echo AdbShellExitCode: $? Stdout: AdbShellExitCode: 0 ExitCode: 0 Time: 0:00:00.070396 Executing adb -s 06ab60b3003b6b35 shell mkdir -p /data/local/tmp/precompilation-testing/test ; echo AdbShellExitCode: $? Stdout: AdbShellExitCode: 0 ExitCode: 0 Time: 0:00:00.065286 Executing Skipped cached push ExitCode: 0 Time: 0:00:00.000043 Executing Skipped cached push ExitCode: 0 Time: 0:00:00.000012 Executing adb -s 06ab60b3003b6b35 shell chmod 777 /data/local/tmp/precompilation-testing/dart_precompiled_runtime /data/local/tmp/precompilation-testing/process_test ; echo AdbShellExitCode: $? Stdout: AdbShellExitCode: 0 ExitCode: 0 Time: 0:00:00.075194 Executing adb -s 06ab60b3003b6b35 push /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.aotsnapshot /data/local/tmp/precompilation-testing/test/out.aotsnapshot Stderr: 2832 KB/s (3488160 bytes in 1.202s) ExitCode: 0 Time: 0:00:01.296336 Executing adb -s 06ab60b3003b6b35 shell /data/local/tmp/precompilation-testing/dart_precompiled_runtime --ignore-unrecognized-flags --packages=/b/swarming/w/ir/.packages /data/local/tmp/precompilation-testing/test/out.aotsnapshot ; echo AdbShellExitCode: $? Stdout: WARNING: linker: /data/local/tmp/precompilation-testing/dart_precompiled_runtime: unused DT entry: type 0x6ffffef5 arg 0x97d74 WARNING: linker: /data/local/tmp/precompilation-testing/dart_precompiled_runtime: unused DT entry: type 0x6ffffffe arg 0xc4f14 WARNING: linker: /data/local/tmp/precompilation-testing/dart_precompiled_runtime: unused DT entry: type 0x6fffffff arg 0x3 AdbShellExitCode: 0 ExitCode: 0 Time: 0:00:00.108513 --- Re-run this test: python tools/test.py -n dartkp-android-release-arm language_2/function_propagation_test 276 out of 781 completed Tests running for 10 minutes 411 out of 781 completed Tests running for 15 minutes 553 out of 781 completed Tests running for 20 minutes 724 out of 781 completed Tests running for 25 minutes === Failure summary: FAILED: dartkp-dart_precompiled release_arm language_2/const_map2_test/00 Expected: MissingCompileTimeError Actual: Pass Missing expected compile error. --- Command "vm_compile_to_kernel []" (took 365ms): DART_CONFIGURATION=ReleaseAndroidARM /b/swarming/w/ir/pkg/vm/tool/gen_kernel --aot --platform=out/ReleaseAndroidARM/vm_platform_strong.dill -o /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/multitest_language_2_const_map2_test_00/out.dill /b/swarming/w/ir/out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart --packages=/b/swarming/w/ir/.packages -Ddart.developer.causal_async_stacks=true exit code: 1 stdout: out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart:24:31: Error: The key 'B {}' does not have a primitive operator '=='. - 'B' is from 'out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart'. dynamic m = const {const A(): 42}; ^ out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart:27:34: Error: The key 'B {}' does not have a primitive operator '=='. - 'B' is from 'out/ReleaseAndroidARM/generated_tests/language_2/const_map2_test_00.dart'. m = const {"foo": 99, const A(): 499}; ^ --- Re-run this test: python tools/test.py -n dartkp-android-release-arm language_2/const_map2_test/00 FAILED: dartkp-dart_precompiled release_arm language_2/function_propagation_test Expected: RuntimeError Actual: Pass --- Command "vm_compile_to_kernel []" (took 01.000277s): DART_CONFIGURATION=ReleaseAndroidARM /b/swarming/w/ir/pkg/vm/tool/gen_kernel --aot --platform=out/ReleaseAndroidARM/vm_platform_strong.dill -o /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.dill /b/swarming/w/ir/tests/language_2/function_propagation_test.dart --packages=/b/swarming/w/ir/.packages -Ddart.developer.causal_async_stacks=true exit code: 0 --- Command "precompiler" (took 03.000348s): DART_CONFIGURATION=ReleaseAndroidARM out/ReleaseAndroidARM/clang_x86/gen_snapshot --snapshot-kind=app-aot-blobs --blobs_container_filename=/b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.aotsnapshot --no-sim-use-hardfp --ignore-unrecognized-flags --packages=/b/swarming/w/ir/.packages /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.dill exit code: 0 --- Command "remove_kernel_file" (took 17ms): DART_CONFIGURATION=ReleaseAndroidARM rm /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.dill exit code: 0 --- Command "adb_precompilation" (took 01.000710s): Steps to push precompiled runner and precompiled code to an attached device. Uses (and requires) adb. exit code: 0 stdout: Executing adb -s 06ab60b3003b6b35 shell rm -Rf /data/local/tmp/precompilation-testing/test ; echo AdbShellExitCode: $? Stdout: AdbShellExitCode: 0 ExitCode: 0 Time: 0:00:00.070396 Executing adb -s 06ab60b3003b6b35 shell mkdir -p /data/local/tmp/precompilation-testing/test ; echo AdbShellExitCode: $? Stdout: AdbShellExitCode: 0 ExitCode: 0 Time: 0:00:00.065286 Executing Skipped cached push ExitCode: 0 Time: 0:00:00.000043 Executing Skipped cached push ExitCode: 0 Time: 0:00:00.000012 Executing adb -s 06ab60b3003b6b35 shell chmod 777 /data/local/tmp/precompilation-testing/dart_precompiled_runtime /data/local/tmp/precompilation-testing/process_test ; echo AdbShellExitCode: $? Stdout: AdbShellExitCode: 0 ExitCode: 0 Time: 0:00:00.075194 Executing adb -s 06ab60b3003b6b35 push /b/swarming/w/ir/out/ReleaseAndroidARM/generated_compilations/dartkp/tests_language_2_function_propagation_test/out.aotsnapshot /data/local/tmp/precompilation-testing/test/out.aotsnapshot Stderr: 2832 KB/s (3488160 bytes in 1.202s) ExitCode: 0 Time: 0:00:01.296336 Executing adb -s 06ab60b3003b6b35 shell /data/local/tmp/precompilation-testing/dart_precompiled_runtime --ignore-unrecognized-flags --packages=/b/swarming/w/ir/.packages /data/local/tmp/precompilation-testing/test/out.aotsnapshot ; echo AdbShellExitCode: $? Stdout: WARNING: linker: /data/local/tmp/precompilation-testing/dart_precompiled_runtime: unused DT entry: type 0x6ffffef5 arg 0x97d74 WARNING: linker: /data/local/tmp/precompilation-testing/dart_precompiled_runtime: unused DT entry: type 0x6ffffffe arg 0xc4f14 WARNING: linker: /data/local/tmp/precompilation-testing/dart_precompiled_runtime: unused DT entry: type 0x6fffffff arg 0x3 AdbShellExitCode: 0 ExitCode: 0 Time: 0:00:00.108513 --- Re-run this test: python tools/test.py -n dartkp-android-release-arm language_2/function_propagation_test === === 2 tests failed === --- Total time: 26:55 --- 0:00:16.222064 - vm_compile_to_kernel [] - dartkp-dart_precompiled release_arm/corelib_2/list_literal_test 0:00:16.218827 - vm_compile_to_kernel [] - dartkp-dart_precompiled release_arm/corelib_2/range_error_test 0:00:15.897929 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/num_clamp_test 0:00:11.976939 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/list_literal_is_growable_test 0:00:11.939924 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/string_source_test 0:00:11.622730 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/double_round_test/int64 0:00:10.020957 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/map_contains_key_test 0:00:09.950138 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/iterable_take_test 0:00:09.785103 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/iterable_contains2_test 0:00:09.288678 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/string_codeunits_test 0:00:09.106642 - precompiler - dartkp-dart_precompiled release_arm/language_2/assign_instance_method_test 0:00:09.072993 - adb_precompilation - dartkp-dart_precompiled release_arm/corelib_2/list_literal_test 0:00:08.782982 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/iterable_element_at_test/none 0:00:08.175424 - precompiler - dartkp-dart_precompiled release_arm/language_2/regress_16640_test 0:00:07.588103 - vm_compile_to_kernel [] - dartkp-dart_precompiled release_arm/corelib_2/queue_last_test 0:00:07.243054 - precompiler - dartkp-dart_precompiled release_arm/language_2/super_no_such_method3_test 0:00:07.155788 - precompiler - dartkp-dart_precompiled release_arm/language_2/invalid_returns/async_invalid_return_01_test/none 0:00:07.076659 - precompiler - dartkp-dart_precompiled release_arm/language_2/instanceof_optimized_test 0:00:06.832963 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/double_try_parse_test/0 0:00:06.643404 - precompiler - dartkp-dart_precompiled release_arm/corelib_2/double_truncate_test/none 2019-05-21 12:13:49,270 - root: [DEBUG] Contents of task_output_dir: ['/b/s/w/ir/tmp/t/tmp1JEztY/44f486ec44c6c610'] 2019-05-21 12:13:49,272 - root: [WARNING] Expected output.json file missing: set(['/b/s/w/ir/tmp/t/tmp1JEztY/44f486ec44c6c610/output.json']) Found: [] Expected: ['/b/s/w/ir/tmp/t/tmp1JEztY/44f486ec44c6c610/output.json'] 2019-05-21 12:13:49,272 - root: [WARNING] No shard json files found in task_output_dir: '/b/s/w/ir/tmp/t/tmp1JEztY' Found ['/b/s/w/ir/tmp/t/tmp1JEztY/44f486ec44c6c610'] 2019-05-21 12:13:49,272 - root: [DEBUG] Found shard_json_files: ['/b/s/w/ir/tmp/t/tmp1JEztY/44f486ec44c6c610/output.json'] 2019-05-21 12:13:49,273 - root: [INFO] merge_cmd: /b/s/w/ir/cache/vpython/f6423e/bin/python /b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/noop_merge.py --summary-json /b/s/w/ir/tmp/t/tmpHCAyv_.json --task-output-dir /b/s/w/ir/tmp/t/tmp1JEztY -o /b/s/w/ir/tmp/t/tmpXRFAbJ.json Running ['/b/s/w/ir/cache/vpython/f6423e/bin/python', '/b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/noop_merge.py', '--summary-json', '/b/s/w/ir/tmp/t/tmpHCAyv_.json', '--task-output-dir', '/b/s/w/ir/tmp/t/tmp1JEztY', '-o', '/b/s/w/ir/tmp/t/tmpXRFAbJ.json'] in None (env: None) Command ['/b/s/w/ir/cache/vpython/f6423e/bin/python', '/b/s/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/chromium_swarming/resources/noop_merge.py', '--summary-json', '/b/s/w/ir/tmp/t/tmpHCAyv_.json', '--task-output-dir', '/b/s/w/ir/tmp/t/tmp1JEztY', '-o', '/b/s/w/ir/tmp/t/tmpXRFAbJ.json'] returned exit code 0