[23:00:58.661] New invocation is queued and will start shortly
[23:01:00.166] Starting the invocation (attempt 1)
[23:01:00.214] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[23:01:00.214] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[23:01:00.214] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9029226451242941392",
"parameters_json": "{\"builder_name\":\"win-asan\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"1bfc40f9840445ff7cb71e2efb58363e906fbb44\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:win-asan",
"scheduler_invocation_id:9029226451242941392",
"scheduler_job_id:chromium/win-asan",
"user_agent:luci-scheduler",
"buildset:commit/git/1bfc40f9840445ff7cb71e2efb58363e906fbb44",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/1bfc40f9840445ff7cb71e2efb58363e906fbb44",
"gitiles_ref:refs/heads/master"
]
}
[23:01:01.246] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"created_by": "project:chromium",
"created_ts": "1605222060359839",
"id": "8863796388795121328",
"parameters_json": "{\"builder_name\": \"win-asan\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"1bfc40f9840445ff7cb71e2efb58363e906fbb44\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1605222060782018",
"tags": [
"build_address:luci.chromium.ci/win-asan/15611",
"builder:win-asan",
"buildset:commit/git/1bfc40f9840445ff7cb71e2efb58363e906fbb44",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/1bfc40f9840445ff7cb71e2efb58363e906fbb44",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9029226451242941392",
"scheduler_job_id:chromium/win-asan",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8863796388795121328/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1605222060782151",
"url": "https://ci.chromium.org/b/8863796388795121328",
"utcnow_ts": "1605222061235027"
}
}
[23:01:01.246] Task URL: https://ci.chromium.org/b/8863796388795121328
[23:01:01.246] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:2:0) after 1m0s
[23:02:01.886] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:2:0)
[23:02:01.886] Timer tick, asking Buildbucket for the build status
[23:02:02.066] Build 8863796388795121328: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[23:02:02.066] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:3:0) after 1m0s
[23:03:02.134] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:3:0)
[23:03:02.134] Timer tick, asking Buildbucket for the build status
[23:03:02.216] Build 8863796388795121328: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[23:03:02.216] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:4:0) after 1m0s
[23:04:02.228] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:4:0)
[23:04:02.228] Timer tick, asking Buildbucket for the build status
[23:04:02.470] Build 8863796388795121328: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[23:04:02.470] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:5:0) after 1m0s
[23:04:49.678] Received PubSub notification, asking Buildbucket for the build status
[23:04:51.319] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:03.285] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:5:0)
[23:05:03.285] Timer tick, asking Buildbucket for the build status
[23:05:03.945] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:03.945] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:7:0) after 1m0s
[23:06:04.002] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:7:0)
[23:06:04.002] Timer tick, asking Buildbucket for the build status
[23:06:04.200] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:04.200] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:8:0) after 1m0s
[23:07:04.267] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:8:0)
[23:07:04.267] Timer tick, asking Buildbucket for the build status
[23:07:04.495] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:04.495] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:9:0) after 1m0s
[23:08:04.587] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:9:0)
[23:08:04.587] Timer tick, asking Buildbucket for the build status
[23:08:04.752] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:04.752] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:10:0) after 1m0s
[23:09:04.765] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:10:0)
[23:09:04.765] Timer tick, asking Buildbucket for the build status
[23:09:04.848] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:04.849] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:11:0) after 1m0s
[23:10:04.906] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:11:0)
[23:10:04.906] Timer tick, asking Buildbucket for the build status
[23:10:05.006] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:05.006] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:12:0) after 1m0s
[23:11:05.328] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:12:0)
[23:11:05.328] Timer tick, asking Buildbucket for the build status
[23:11:05.517] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:05.517] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:13:0) after 1m0s
[23:12:05.627] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:13:0)
[23:12:05.627] Timer tick, asking Buildbucket for the build status
[23:12:05.859] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:05.859] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:14:0) after 1m0s
[23:13:05.909] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:14:0)
[23:13:05.909] Timer tick, asking Buildbucket for the build status
[23:13:06.124] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:06.124] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:15:0) after 1m0s
[23:14:06.565] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:15:0)
[23:14:06.565] Timer tick, asking Buildbucket for the build status
[23:14:07.767] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:07.767] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:16:0) after 1m0s
[23:15:07.961] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:16:0)
[23:15:07.961] Timer tick, asking Buildbucket for the build status
[23:15:08.113] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:08.113] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:17:0) after 1m0s
[23:16:08.194] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:17:0)
[23:16:08.194] Timer tick, asking Buildbucket for the build status
[23:16:08.628] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:08.628] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:18:0) after 1m0s
[23:17:08.678] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:18:0)
[23:17:08.678] Timer tick, asking Buildbucket for the build status
[23:17:08.924] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:08.924] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:19:0) after 1m0s
[23:18:08.995] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:19:0)
[23:18:08.995] Timer tick, asking Buildbucket for the build status
[23:18:09.167] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:09.167] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:20:0) after 1m0s
[23:19:09.298] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:20:0)
[23:19:09.298] Timer tick, asking Buildbucket for the build status
[23:19:09.379] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:09.379] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:21:0) after 1m0s
[23:20:09.512] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:21:0)
[23:20:09.512] Timer tick, asking Buildbucket for the build status
[23:20:09.600] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:09.600] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:22:0) after 1m0s
[23:21:09.943] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:22:0)
[23:21:09.943] Timer tick, asking Buildbucket for the build status
[23:21:10.153] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:10.153] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:23:0) after 1m0s
[23:22:10.304] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:23:0)
[23:22:10.304] Timer tick, asking Buildbucket for the build status
[23:22:10.373] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:10.373] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:24:0) after 1m0s
[23:23:12.687] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:24:0)
[23:23:12.687] Timer tick, asking Buildbucket for the build status
[23:23:12.776] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:12.776] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:25:0) after 1m0s
[23:24:12.897] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:25:0)
[23:24:12.897] Timer tick, asking Buildbucket for the build status
[23:24:13.155] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:13.155] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:26:0) after 1m0s
[23:25:13.257] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:26:0)
[23:25:13.257] Timer tick, asking Buildbucket for the build status
[23:25:13.962] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:13.962] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:27:0) after 1m0s
[23:26:14.015] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:27:0)
[23:26:14.016] Timer tick, asking Buildbucket for the build status
[23:26:14.386] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:14.386] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:28:0) after 1m0s
[23:27:14.448] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:28:0)
[23:27:14.448] Timer tick, asking Buildbucket for the build status
[23:27:14.520] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:14.520] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:29:0) after 1m0s
[23:28:14.523] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:29:0)
[23:28:14.523] Timer tick, asking Buildbucket for the build status
[23:28:14.746] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:14.746] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:30:0) after 1m0s
[23:29:14.858] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:30:0)
[23:29:14.858] Timer tick, asking Buildbucket for the build status
[23:29:14.960] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:14.960] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:31:0) after 1m0s
[23:30:15.072] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:31:0)
[23:30:15.073] Timer tick, asking Buildbucket for the build status
[23:30:18.732] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:18.732] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:32:0) after 1m0s
[23:31:18.778] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:32:0)
[23:31:18.778] Timer tick, asking Buildbucket for the build status
[23:31:18.877] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:18.877] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:33:0) after 1m0s
[23:32:18.874] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:33:0)
[23:32:18.874] Timer tick, asking Buildbucket for the build status
[23:32:19.662] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:19.662] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:34:0) after 1m0s
[23:33:19.801] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:34:0)
[23:33:19.801] Timer tick, asking Buildbucket for the build status
[23:33:19.868] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:19.868] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:35:0) after 1m0s
[23:34:19.884] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:35:0)
[23:34:19.884] Timer tick, asking Buildbucket for the build status
[23:34:20.010] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:20.010] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:36:0) after 1m0s
[23:35:20.090] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:36:0)
[23:35:20.090] Timer tick, asking Buildbucket for the build status
[23:35:20.398] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:20.398] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:37:0) after 1m0s
[23:36:20.573] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:37:0)
[23:36:20.573] Timer tick, asking Buildbucket for the build status
[23:36:22.987] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:22.987] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:38:0) after 1m0s
[23:37:23.010] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:38:0)
[23:37:23.010] Timer tick, asking Buildbucket for the build status
[23:37:23.093] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:37:23.093] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:39:0) after 1m0s
[23:38:23.188] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:39:0)
[23:38:23.188] Timer tick, asking Buildbucket for the build status
[23:38:23.321] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:38:23.321] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:40:0) after 1m0s
[23:39:23.376] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:40:0)
[23:39:23.376] Timer tick, asking Buildbucket for the build status
[23:39:23.480] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:23.480] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:41:0) after 1m0s
[23:40:23.501] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:41:0)
[23:40:23.501] Timer tick, asking Buildbucket for the build status
[23:40:23.578] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:23.578] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:42:0) after 1m0s
[23:41:23.608] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:42:0)
[23:41:23.608] Timer tick, asking Buildbucket for the build status
[23:41:23.801] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:41:23.802] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:43:0) after 1m0s
[23:42:23.820] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:43:0)
[23:42:23.820] Timer tick, asking Buildbucket for the build status
[23:42:23.904] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:42:23.904] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:44:0) after 1m0s
[23:43:23.965] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:44:0)
[23:43:23.965] Timer tick, asking Buildbucket for the build status
[23:43:24.043] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:43:24.043] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:45:0) after 1m0s
[23:44:24.177] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:45:0)
[23:44:24.177] Timer tick, asking Buildbucket for the build status
[23:44:24.288] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:44:24.288] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:46:0) after 1m0s
[23:45:24.349] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:46:0)
[23:45:24.349] Timer tick, asking Buildbucket for the build status
[23:45:24.675] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:45:24.675] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:47:0) after 1m0s
[23:46:24.757] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:47:0)
[23:46:24.757] Timer tick, asking Buildbucket for the build status
[23:46:25.159] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:46:25.160] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:48:0) after 1m0s
[23:47:25.252] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:48:0)
[23:47:25.252] Timer tick, asking Buildbucket for the build status
[23:47:25.325] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:47:25.325] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:49:0) after 1m0s
[23:48:25.388] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:49:0)
[23:48:25.388] Timer tick, asking Buildbucket for the build status
[23:48:25.655] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:48:25.655] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:50:0) after 1m0s
[23:49:25.773] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:50:0)
[23:49:25.773] Timer tick, asking Buildbucket for the build status
[23:49:25.850] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:49:25.850] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:51:0) after 1m0s
[23:50:26.008] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:51:0)
[23:50:26.008] Timer tick, asking Buildbucket for the build status
[23:50:26.239] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:50:26.239] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:52:0) after 1m0s
[23:51:26.300] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:52:0)
[23:51:26.300] Timer tick, asking Buildbucket for the build status
[23:51:26.443] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:51:26.443] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:53:0) after 1m0s
[23:52:26.535] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:53:0)
[23:52:26.535] Timer tick, asking Buildbucket for the build status
[23:52:26.813] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:52:26.813] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:54:0) after 1m0s
[23:53:26.850] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:54:0)
[23:53:26.850] Timer tick, asking Buildbucket for the build status
[23:53:27.116] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:27.116] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:55:0) after 1m0s
[23:54:27.123] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:55:0)
[23:54:27.123] Timer tick, asking Buildbucket for the build status
[23:54:27.401] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:27.401] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:56:0) after 1m0s
[23:55:27.463] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:56:0)
[23:55:27.463] Timer tick, asking Buildbucket for the build status
[23:55:27.645] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:27.645] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:57:0) after 1m0s
[23:56:27.710] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:57:0)
[23:56:27.710] Timer tick, asking Buildbucket for the build status
[23:56:28.102] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:28.102] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:58:0) after 1m0s
[23:57:28.121] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:58:0)
[23:57:28.121] Timer tick, asking Buildbucket for the build status
[23:57:28.194] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:57:28.194] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:59:0) after 1m0s
[23:58:28.276] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:59:0)
[23:58:28.276] Timer tick, asking Buildbucket for the build status
[23:58:28.359] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:58:28.359] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:60:0) after 1m0s
[23:59:28.420] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:60:0)
[23:59:28.420] Timer tick, asking Buildbucket for the build status
[23:59:29.517] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:59:29.517] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:61:0) after 1m0s
[00:00:29.758] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:61:0)
[00:00:29.758] Timer tick, asking Buildbucket for the build status
[00:00:30.424] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:00:30.426] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:62:0) after 1m0s
[00:01:30.505] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:62:0)
[00:01:30.505] Timer tick, asking Buildbucket for the build status
[00:01:30.887] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:01:30.887] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:63:0) after 1m0s
[00:02:30.990] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:63:0)
[00:02:30.990] Timer tick, asking Buildbucket for the build status
[00:02:31.142] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:02:31.142] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:64:0) after 1m0s
[00:03:31.263] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:64:0)
[00:03:31.263] Timer tick, asking Buildbucket for the build status
[00:03:31.877] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:03:31.877] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:65:0) after 1m0s
[00:04:31.965] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:65:0)
[00:04:31.965] Timer tick, asking Buildbucket for the build status
[00:04:32.202] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:32.202] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:66:0) after 1m0s
[00:05:32.323] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:66:0)
[00:05:32.323] Timer tick, asking Buildbucket for the build status
[00:05:32.776] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:32.776] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:67:0) after 1m0s
[00:06:32.886] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:67:0)
[00:06:32.886] Timer tick, asking Buildbucket for the build status
[00:06:32.992] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:32.992] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:68:0) after 1m0s
[00:07:33.085] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:68:0)
[00:07:33.085] Timer tick, asking Buildbucket for the build status
[00:07:33.211] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:33.211] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:69:0) after 1m0s
[00:08:33.290] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:69:0)
[00:08:33.290] Timer tick, asking Buildbucket for the build status
[00:08:33.889] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:08:33.889] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:70:0) after 1m0s
[00:09:34.024] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:70:0)
[00:09:34.024] Timer tick, asking Buildbucket for the build status
[00:09:34.138] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:34.138] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:71:0) after 1m0s
[00:10:34.236] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:71:0)
[00:10:34.236] Timer tick, asking Buildbucket for the build status
[00:10:34.723] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:34.723] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:72:0) after 1m0s
[00:11:34.835] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:72:0)
[00:11:34.835] Timer tick, asking Buildbucket for the build status
[00:11:34.974] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:34.974] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:73:0) after 1m0s
[00:12:35.175] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:73:0)
[00:12:35.175] Timer tick, asking Buildbucket for the build status
[00:12:35.350] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:35.350] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:74:0) after 1m0s
[00:13:35.522] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:74:0)
[00:13:35.522] Timer tick, asking Buildbucket for the build status
[00:13:35.602] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:13:35.602] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:75:0) after 1m0s
[00:14:35.671] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:75:0)
[00:14:35.671] Timer tick, asking Buildbucket for the build status
[00:14:36.025] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:36.025] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:76:0) after 1m0s
[00:15:36.097] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:76:0)
[00:15:36.097] Timer tick, asking Buildbucket for the build status
[00:15:36.243] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:36.243] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:77:0) after 1m0s
[00:16:36.395] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:77:0)
[00:16:36.395] Timer tick, asking Buildbucket for the build status
[00:16:36.598] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:36.598] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:78:0) after 1m0s
[00:17:36.699] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:78:0)
[00:17:36.699] Timer tick, asking Buildbucket for the build status
[00:17:37.142] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:37.142] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:79:0) after 1m0s
[00:18:37.215] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:79:0)
[00:18:37.215] Timer tick, asking Buildbucket for the build status
[00:18:38.719] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:18:38.719] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:80:0) after 1m0s
[00:19:38.820] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:80:0)
[00:19:38.820] Timer tick, asking Buildbucket for the build status
[00:19:39.747] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:39.747] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:81:0) after 1m0s
[00:20:39.942] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:81:0)
[00:20:39.942] Timer tick, asking Buildbucket for the build status
[00:20:40.074] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:40.074] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:82:0) after 1m0s
[00:21:40.108] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:82:0)
[00:21:40.108] Timer tick, asking Buildbucket for the build status
[00:21:40.228] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:40.228] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:83:0) after 1m0s
[00:22:40.269] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:83:0)
[00:22:40.269] Timer tick, asking Buildbucket for the build status
[00:22:41.034] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:41.034] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:84:0) after 1m0s
[00:23:41.074] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:84:0)
[00:23:41.074] Timer tick, asking Buildbucket for the build status
[00:23:41.199] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:41.199] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:85:0) after 1m0s
[00:24:41.234] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:85:0)
[00:24:41.234] Timer tick, asking Buildbucket for the build status
[00:24:41.393] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:41.393] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:86:0) after 1m0s
[00:25:41.398] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:86:0)
[00:25:41.399] Timer tick, asking Buildbucket for the build status
[00:25:42.004] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:42.004] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:87:0) after 1m0s
[00:26:42.076] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:87:0)
[00:26:42.076] Timer tick, asking Buildbucket for the build status
[00:26:42.214] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:42.214] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:88:0) after 1m0s
[00:27:42.242] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:88:0)
[00:27:42.242] Timer tick, asking Buildbucket for the build status
[00:27:42.509] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:42.509] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:89:0) after 1m0s
[00:28:42.537] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:89:0)
[00:28:42.537] Timer tick, asking Buildbucket for the build status
[00:28:44.848] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:44.848] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:90:0) after 1m0s
[00:29:44.881] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:90:0)
[00:29:44.881] Timer tick, asking Buildbucket for the build status
[00:29:45.009] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:29:45.009] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:91:0) after 1m0s
[00:30:45.035] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:91:0)
[00:30:45.035] Timer tick, asking Buildbucket for the build status
[00:30:45.162] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:30:45.162] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:92:0) after 1m0s
[00:31:45.339] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:92:0)
[00:31:45.339] Timer tick, asking Buildbucket for the build status
[00:31:45.519] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:31:45.519] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:93:0) after 1m0s
[00:32:45.604] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:93:0)
[00:32:45.604] Timer tick, asking Buildbucket for the build status
[00:32:45.681] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:32:45.681] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:94:0) after 1m0s
[00:33:45.744] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:94:0)
[00:33:45.744] Timer tick, asking Buildbucket for the build status
[00:33:45.837] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:33:45.837] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:95:0) after 1m0s
[00:34:45.897] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:95:0)
[00:34:45.897] Timer tick, asking Buildbucket for the build status
[00:34:46.013] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:34:46.013] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:96:0) after 1m0s
[00:35:46.018] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:96:0)
[00:35:46.018] Timer tick, asking Buildbucket for the build status
[00:35:46.165] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:35:46.165] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:97:0) after 1m0s
[00:36:46.167] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:97:0)
[00:36:46.167] Timer tick, asking Buildbucket for the build status
[00:36:46.433] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:36:46.433] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:98:0) after 1m0s
[00:37:46.442] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:98:0)
[00:37:46.442] Timer tick, asking Buildbucket for the build status
[00:37:47.123] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:37:47.123] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:99:0) after 1m0s
[00:38:47.159] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:99:0)
[00:38:47.159] Timer tick, asking Buildbucket for the build status
[00:38:47.338] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:38:47.338] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:100:0) after 1m0s
[00:39:47.376] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:100:0)
[00:39:47.376] Timer tick, asking Buildbucket for the build status
[00:39:47.817] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:39:47.817] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:101:0) after 1m0s
[00:40:47.846] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:101:0)
[00:40:47.846] Timer tick, asking Buildbucket for the build status
[00:40:47.913] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:40:47.913] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:102:0) after 1m0s
[00:41:47.956] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:102:0)
[00:41:47.956] Timer tick, asking Buildbucket for the build status
[00:41:48.345] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:41:48.345] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:103:0) after 1m0s
[00:42:48.405] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:103:0)
[00:42:48.405] Timer tick, asking Buildbucket for the build status
[00:42:48.576] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:42:48.576] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:104:0) after 1m0s
[00:43:49.065] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:104:0)
[00:43:49.065] Timer tick, asking Buildbucket for the build status
[00:43:49.153] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:43:49.153] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:105:0) after 1m0s
[00:44:49.232] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:105:0)
[00:44:49.232] Timer tick, asking Buildbucket for the build status
[00:44:49.391] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:44:49.391] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:106:0) after 1m0s
[00:45:49.591] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:106:0)
[00:45:49.591] Timer tick, asking Buildbucket for the build status
[00:45:49.684] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:45:49.684] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:107:0) after 1m0s
[00:46:49.772] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:107:0)
[00:46:49.773] Timer tick, asking Buildbucket for the build status
[00:46:49.945] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:46:49.945] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:108:0) after 1m0s
[00:47:49.995] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:108:0)
[00:47:49.995] Timer tick, asking Buildbucket for the build status
[00:47:50.590] Build 8863796388795121328: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:47:50.591] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:109:0) after 1m0s
[00:48:50.642] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9029226451242941392:109:0)
[00:48:50.642] Timer tick, asking Buildbucket for the build status
[00:48:51.323] Build 8863796388795121328: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[00:48:51.324] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"completed_ts": "1605228529876890",
"created_by": "project:chromium",
"created_ts": "1605222060359839",
"failure_reason": "BUILD_FAILURE",
"id": "8863796388795121328",
"parameters_json": "{\"builder_name\": \"win-asan\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"1bfc40f9840445ff7cb71e2efb58363e906fbb44\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed because of:\\n\\n- PDFExtensionTestWithParam.ExtensionlessPDFLocalFileLoads/1\\n\\n- PDFExtensionTestWithParam.ExtensionlessPDFLocalFileLoads/0\\n\\n- All/PDFExtensionAccessibilityTreeDumpTest.TextFields/win_updateEnabled\\n\\n- All/PDFExtensionAccessibilityTreeDumpTest.DirectionalTextRuns/win_updateDisabled\\n\\n- ...242 more failure(s) (246 total)...\"}, \"properties\": {\"$build/goma\": {\"enable_ats\": true, \"jobs\": 500.0, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$recipe_engine/milo/blamelist_pins\": [{\"host\": \"chromium.googlesource.com\", \"id\": \"1bfc40f9840445ff7cb71e2efb58363e906fbb44\", \"project\": \"chromium/src\"}], \"$recipe_engine/path\": {\"cache_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\cache\", \"temp_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\tmp\\\\rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"luci-chromium-ci-win10-32-0-4yp8\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.memory\", \"buildername\": \"win-asan\", \"buildnumber\": 15611, \"clang_revision\": \"llvmorg-12-init-11462-g418f18c6-1\", \"got_angle_revision\": \"f9e59ad078552424ca165644f4da3b4e2687c3dc\", \"got_dawn_revision\": \"01e969da331866d408f23d12229b61cc17ef07bf\", \"got_nacl_revision\": \"f9e6f257d1a0934dbeed3c5c8f83b651dc4f55e1\", \"got_revision\": \"1bfc40f9840445ff7cb71e2efb58363e906fbb44\", \"got_revision_cp\": \"refs/heads/master@{#827018}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"e6dc3d37f58c00c8818742cc27a69f793bea5672\", \"got_v8_revision\": \"2dbcdc105b963ee2501c82139eef7e0603977ff0\", \"got_v8_revision_cp\": \"refs/heads/8.8.278@{#1}\", \"got_webrtc_revision\": \"40e2a6830ac5f07b03dafefb014492612f4fb650\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32595}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mirrored_builders\": [\"tryserver.chromium.win:win-asan\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"1bfc40f9840445ff7cb71e2efb58363e906fbb44\", \"swarm_hashes_refs/heads/master(at){#827018}_without_patch\": {\"absl_hardening_tests\": \"5a5781f53a7d1c30db15507258a4542b99bf36f4\", \"accessibility_unittests\": \"e0fbf400fbc3971d29fadd4e3b643735836bbd8c\", \"angle_unittests\": \"476d41bc2f4d1a631acb99ed863ed11f5e6bb741\", \"app_shell_unittests\": \"860fe05000470a6269177379086df453d9788398\", \"aura_unittests\": \"b457d9b1d9642ab724dac8e09a1be7f0624b2e22\", \"base_unittests\": \"bb0edb3919a0e7b495d53cb2e8e2ba62936aa856\", \"base_util_unittests\": \"b4ccb142e2c557700be79864e9dde6addb34980d\", \"blink_common_unittests\": \"9bdb8280fd2181b3adf9c78f010aa77a63ac18c0\", \"blink_fuzzer_unittests\": \"420d4515b9cab94d5f6b33865821d5d3e0c8ec7a\", \"blink_heap_unittests\": \"6b8de470d474006eb3621b4558b17b6e1b00be78\", \"blink_platform_unittests\": \"4f5f2bcc3dbaa8a5133813797828dd236bf2f66a\", \"blink_unittests\": \"7f375cf2fa73650d82f936cc1bdfab26c310660d\", \"boringssl_crypto_tests\": \"656a40d06ec2e3757c2fd7e9773d0f296297d330\", \"boringssl_ssl_tests\": \"eb2835ae19f38d8fd53e13c29335a5189e12ac4e\", \"browser_switcher_bho_unittests\": \"a06c50661433eff91181a35c6ac6f1404f995625\", \"browser_tests\": \"3e3a193482e7992d25d4933441a2ef589219787e\", \"capture_unittests\": \"f79634d6f52f58d1feb165926fdcc5a8fe0f9b48\", \"cast_unittests\": \"9cd37544b4d49f3a91574e568a7de6c8af7f0577\", \"cc_unittests\": \"9c024b428bf477a3bf34263e88c97d12684a0a9f\", \"chrome_app_unittests\": \"655aac162d18fd40bb589b6a5432a3b8fe908133\", \"chrome_cleaner_unittests\": \"4fd4f9d3d26a8d6be84db6c7f0377f22d02f3909\", \"chrome_elf_unittests\": \"d7cc586188f089adb76a1f82e94382ec750a015d\", \"chromedriver_unittests\": \"9aeacc5a2331388e4a6575a890dc4fab9cfa48f5\", \"components_browsertests\": \"6071511d2815b1b816bda8be074d4fb386478933\", \"components_unittests\": \"b2e283548de4172c3d8d742fbc45d6853e95cc89\", \"compositor_unittests\": \"d3c66529df133cf2915c85313d8edc5789689fdc\", \"content_browsertests\": \"b444c87095ebb09f0496d6dec993878936b8c2f9\", \"content_unittests\": \"10c412e6e398140956401215fbfb9e5554de0aaf\", \"courgette_unittests\": \"02432b56df75f159dcaabcf40d674639d12b8b4f\", \"crashpad_tests\": \"6f17d3a55cf92cef1a25b513b4971449e1d395a5\", \"cronet_tests\": \"9aa269270f6926fa912f3d811d9490df8270fe6b\", \"cronet_unittests\": \"cfb18fed28e98447396d07cde6191e962ec2f093\", \"crypto_unittests\": \"277f463c506076085c71dad7c9d7eb5d23cc6091\", \"delayloads_unittests\": \"3b7d6aab6b7fcba214c9477641aeac62c3e8cde9\", \"device_unittests\": \"c24f6bdccd3be796099091633b32daeca9d83e83\", \"display_unittests\": \"7dfd592f6a9b85cf00f153c4a3694cdf4b99ad80\", \"elevation_service_unittests\": \"be781f9a41586f2174c1e26114f976f449a358ba\", \"events_unittests\": \"76a0dc0aa92cba53eb9e4038ddea84f588685eb9\", \"extensions_browsertests\": \"65cab411abbaba16efecdbcb10176f9cbc177d62\", \"extensions_unittests\": \"82aed715f7c5b37855d0ec57a865508bcd0d381e\", \"filesystem_service_unittests\": \"48d0efd6cf400b13cec8e26bbe0e3a8fdf03992a\", \"gcm_unit_tests\": \"972925396f80c9830d253250a2d439a680e65ff7\", \"gcp_unittests\": \"66896d206390d6bcadc08758bffe4109b10271a9\", \"gfx_unittests\": \"51ec757b75c11398740b9f2c7793c03e6b5e9462\", \"gin_unittests\": \"572d1617f5e34ce7a75db4313d3054ebc1a69c16\", \"google_apis_unittests\": \"fe6c17403cdf424a835c7f37dae573d35b8f631e\", \"gpu_unittests\": \"679d47aee7915ba42923f2e565202f72207f2efe\", \"gwp_asan_unittests\": \"2d7064a5dc5800a1325634d944980f1b1f4fdb47\", \"headless_browsertests\": \"ce7b5cdc7f394781bd060dbf49e4c52cb78bf8c2\", \"headless_unittests\": \"0e9b6ae061e023cb86ce585c473cc8f4468febd0\", \"install_static_unittests\": \"69d42a50dfa0a6d25d3be10b302b5cc04c8005bc\", \"installer_util_unittests\": \"a570edfe263884697a92b2312995d1c93731aee4\", \"interactive_ui_tests\": \"a1282bc7795810a2744e09db170533a83e8f2cfd\", \"ipc_tests\": \"6562f5b801950bc0fcb313c1a2e79cc32ec484f8\", \"jingle_unittests\": \"4fa2c21fffcc6aa99a30cf499ed09da2ebd529cc\", \"latency_unittests\": \"a25b0047c494dd89967191811b754fd58b4e1097\", \"libjingle_xmpp_unittests\": \"b0ec07561cf1f7ae640c069ced7d0f995dab98d1\", \"liburlpattern_unittests\": \"ffecee4189254593731e6070fe0edbd2214d89f7\", \"media_blink_unittests\": \"eda2db6a0e6e7007b9212dd5bd5e20567baaa44f\", \"media_unittests\": \"54644d15ef5ac45013e26b41a1b808f88b7ee386\", \"message_center_unittests\": \"f59c7407b123c48ae2f0a80c53df3b4f0d74e90b\", \"midi_unittests\": \"ef61fe316f1191126c627cde3c8a3aaac78a8ea1\", \"mojo_core_unittests\": \"fdaeaaa0ead9c9bb85f407587787ef51b6b78319\", \"mojo_unittests\": \"6d1e88f7780f5da1209e91a3fb7bce657dfb1da3\", \"nacl_loader_unittests\": \"fe7acae1cb65a38c2ee67458f0eef298fe3ba560\", \"native_theme_unittests\": \"95f5c3d0d9929dce11c802551cfcd6c706e9cb61\", \"net_unittests\": \"6268b0fad6e854fdf38592d832f3341264cabc22\", \"notification_helper_unittests\": \"670d56643d993260333c6aa8d19510655de03e97\", \"pdf_unittests\": \"db355c35e5b0910ea264290db6ccb28ffa2470b5\", \"perfetto_unittests\": \"e502daf3cfc9c2ca24428fb2a9864d26da181dd9\", \"ppapi_unittests\": \"fda4b777dc582803163b11a728375bf69d936f38\", \"printing_unittests\": \"d61131e2a38e82b11dfcf51de56ccd22e0600b73\", \"remoting_unittests\": \"aa2311eba15ce844d2a61f4abdb60c46cb35dfb1\", \"sbox_integration_tests\": \"137f9769a9af5471410df8112daff091106dd0ad\", \"sbox_unittests\": \"43c1c48e68af5051aa963581b9f702068c974d18\", \"sbox_validation_tests\": \"7c28cd1ce6d001c34feb143d7da0c496ed891d10\", \"service_manager_unittests\": \"ffcd5b4afb50a0a7e7bcf9e7adc7a513bf3729c5\", \"services_unittests\": \"27d2367031dce581b1fc2da63b7175aeb62d9359\", \"setup_unittests\": \"b1c92a5052f4b67cad3db7de5b9705bd9a03bb3a\", \"shell_dialogs_unittests\": \"9878a86ab24ff8a41534ccc03aa06949e41ca6e7\", \"skia_unittests\": \"456c360b2abd6353567856658f6f87c4c8e81f24\", \"snapshot_unittests\": \"923c8b477b7b8061e335bc6ba20000373d2aa73b\", \"sql_unittests\": \"c6067168b87d7c1527d9ffb4f4ecff1330536e2f\", \"storage_unittests\": \"8373e93d360ec41fddbcfad8b6bb9d6a80bead88\", \"sync_integration_tests\": \"fa7831ed863ec799e36b2cfde590dba7f637a438\", \"traffic_annotation_auditor_unittests\": \"691eba4f3a12c391885ea714ee5030006b90d182\", \"ui_base_unittests\": \"3a7685ca634c388d6ebfb0735fa4cfc8f00b9b5f\", \"ui_touch_selection_unittests\": \"4b889261e5679b70991a8bf7d020c01880100524\", \"unit_tests\": \"17ce6a79913c767120dbcab17b3477c5a36d4a3a\", \"updater_tests\": \"21dc808e40544bff84e960c1c8cd9ec174f0dd0f\", \"url_unittests\": \"cec2ebb365ed65f1e70a63de21e53ffcf638495e\", \"views_unittests\": \"701bd2eda079866041563d6963cf31f73601181b\", \"viz_unittests\": \"0ebcf58bd8948ee7780ab0b40b75c106ee3a567b\", \"vr_common_unittests\": \"921e53866168d89ef996610c1e65e1782171e511\", \"vr_pixeltests\": \"8e0ab83cc9e845645e7c04fde3f203fb3a2fa410\", \"weblayer_browsertests\": \"480f806b536727d4b1a17d1a59a38287955d4312\", \"weblayer_unittests\": \"7df01ce1ce3eac9ad9d0a3bd2f09fb5a5196c0e6\", \"wm_unittests\": \"745737b648b3aff2cd715ecbdfaa0ff9c9888537\", \"wtf_unittests\": \"3352fa91544655f949d65eb9853e2a616dfb7d47\", \"zlib_unittests\": \"730c7208fed31f2eeaeec924cbf9710d8d171e53\", \"zucchini_unittests\": \"b42cc25cbb64b124c1e369f53e925ce986c998a7\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_c244a7c1904bb59c4b6cd021ade0aa3730bbe3d07abc076b32cf6cdc63527337_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-win10-32-0-4yp8\"], \"image\": [\"chrome-win10-1703-20092300-22ba5320847\"], \"integrity\": [\"high\"], \"locale\": [\"en_US.cp1252\"], \"machine_type\": [\"e2-standard-32\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.13\"], \"server_version\": [\"5626-39642e9\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-b\"]}}, \"ui\": {\"info\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed because of:\\n\\n- PDFExtensionTestWithParam.ExtensionlessPDFLocalFileLoads/1\\n\\n- PDFExtensionTestWithParam.ExtensionlessPDFLocalFileLoads/0\\n\\n- All/PDFExtensionAccessibilityTreeDumpTest.TextFields/win_updateEnabled\\n\\n- All/PDFExtensionAccessibilityTreeDumpTest.DirectionalTextRuns/win_updateDisabled\\n\\n- ...242 more failure(s) (246 total)...\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1605222279352773",
"status": "COMPLETED",
"status_changed_ts": "1605222288765821",
"tags": [
"build_address:luci.chromium.ci/win-asan/15611",
"builder:win-asan",
"buildset:commit/git/1bfc40f9840445ff7cb71e2efb58363e906fbb44",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/1bfc40f9840445ff7cb71e2efb58363e906fbb44",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9029226451242941392",
"scheduler_job_id:chromium/win-asan",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8863796388795121328/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Windows",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:4fd7825c7bad2710",
"user_agent:luci-scheduler"
],
"updated_ts": "1605228530582243",
"url": "https://ci.chromium.org/b/8863796388795121328",
"utcnow_ts": "1605228531239091"
}
}
[00:48:51.325] Invocation finished in 1h47m52.683700587s with status FAILED