[10:08:40.142] New invocation is queued and will start shortly
[10:08:41.243] Starting the invocation (attempt 1)
[10:08:41.288] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[10:08:41.288] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[10:08:41.288] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9022208477319426944",
"parameters_json": "{\"builder_name\":\"win-asan\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"069b89dff7b0e7e044f3529b4e730609c0a2bfed\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:win-asan",
"scheduler_invocation_id:9022208477319426944",
"scheduler_job_id:chromium/win-asan",
"user_agent:luci-scheduler",
"buildset:commit/git/069b89dff7b0e7e044f3529b4e730609c0a2bfed",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/069b89dff7b0e7e044f3529b4e730609c0a2bfed",
"gitiles_ref:refs/heads/master"
]
}
[10:08:41.946] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1611914921395038",
"id": "8856778415342011584",
"parameters_json": "{\"builder_name\": \"win-asan\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"069b89dff7b0e7e044f3529b4e730609c0a2bfed\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1611914921804602",
"tags": [
"build_address:luci.chromium.ci/win-asan/17066",
"builder:win-asan",
"buildset:commit/git/069b89dff7b0e7e044f3529b4e730609c0a2bfed",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/069b89dff7b0e7e044f3529b4e730609c0a2bfed",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9022208477319426944",
"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/8856778415342011584/+/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": "1611914921804758",
"url": "https://ci.chromium.org/b/8856778415342011584",
"utcnow_ts": "1611914921935878"
}
}
[10:08:41.946] Task URL: https://ci.chromium.org/b/8856778415342011584
[10:08:41.946] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:2:0) after 1m0s
[10:08:46.127] Received PubSub notification, asking Buildbucket for the build status
[10:08:46.198] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:09:41.948] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:2:0)
[10:09:41.948] Timer tick, asking Buildbucket for the build status
[10:09:42.049] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:09:42.049] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:4:0) after 1m0s
[10:10:42.047] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:4:0)
[10:10:42.047] Timer tick, asking Buildbucket for the build status
[10:10:42.147] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:10:42.147] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:5:0) after 1m0s
[10:11:42.261] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:5:0)
[10:11:42.261] Timer tick, asking Buildbucket for the build status
[10:11:42.372] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:11:42.372] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:6:0) after 1m0s
[10:12:42.464] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:6:0)
[10:12:42.464] Timer tick, asking Buildbucket for the build status
[10:12:42.901] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:12:42.901] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:7:0) after 1m0s
[10:13:43.002] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:7:0)
[10:13:43.002] Timer tick, asking Buildbucket for the build status
[10:13:43.250] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:13:43.250] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:8:0) after 1m0s
[10:14:43.431] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:8:0)
[10:14:43.431] Timer tick, asking Buildbucket for the build status
[10:14:43.534] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:14:43.534] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:9:0) after 1m0s
[10:15:43.682] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:9:0)
[10:15:43.682] Timer tick, asking Buildbucket for the build status
[10:15:43.746] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:15:43.746] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:10:0) after 1m0s
[10:16:43.918] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:10:0)
[10:16:43.918] Timer tick, asking Buildbucket for the build status
[10:16:44.001] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:16:44.001] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:11:0) after 1m0s
[10:17:44.031] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:11:0)
[10:17:44.031] Timer tick, asking Buildbucket for the build status
[10:17:44.125] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:17:44.125] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:12:0) after 1m0s
[10:18:44.256] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:12:0)
[10:18:44.256] Timer tick, asking Buildbucket for the build status
[10:18:44.341] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:18:44.341] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:13:0) after 1m0s
[10:19:44.442] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:13:0)
[10:19:44.442] Timer tick, asking Buildbucket for the build status
[10:19:44.557] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:19:44.557] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:14:0) after 1m0s
[10:20:44.682] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:14:0)
[10:20:44.682] Timer tick, asking Buildbucket for the build status
[10:20:45.127] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:20:45.127] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:15:0) after 1m0s
[10:21:48.138] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:15:0)
[10:21:48.138] Timer tick, asking Buildbucket for the build status
[10:21:48.547] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:21:48.548] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:16:0) after 1m0s
[10:22:48.571] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:16:0)
[10:22:48.571] Timer tick, asking Buildbucket for the build status
[10:22:48.697] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:22:48.697] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:17:0) after 1m0s
[10:23:48.775] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:17:0)
[10:23:48.775] Timer tick, asking Buildbucket for the build status
[10:23:49.307] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:23:49.307] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:18:0) after 1m0s
[10:24:50.231] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:18:0)
[10:24:50.231] Timer tick, asking Buildbucket for the build status
[10:24:50.341] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:24:50.341] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:19:0) after 1m0s
[10:25:50.681] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:19:0)
[10:25:50.681] Timer tick, asking Buildbucket for the build status
[10:25:50.822] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:25:50.822] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:20:0) after 1m0s
[10:26:50.989] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:20:0)
[10:26:50.989] Timer tick, asking Buildbucket for the build status
[10:26:51.102] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:26:51.102] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:21:0) after 1m0s
[10:27:51.189] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:21:0)
[10:27:51.189] Timer tick, asking Buildbucket for the build status
[10:27:51.643] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:27:51.643] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:22:0) after 1m0s
[10:28:51.717] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:22:0)
[10:28:51.717] Timer tick, asking Buildbucket for the build status
[10:28:51.909] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:28:51.909] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:23:0) after 1m0s
[10:29:52.019] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:23:0)
[10:29:52.019] Timer tick, asking Buildbucket for the build status
[10:29:52.135] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:29:52.135] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:24:0) after 1m0s
[10:30:52.149] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:24:0)
[10:30:52.149] Timer tick, asking Buildbucket for the build status
[10:30:52.211] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:30:52.211] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:25:0) after 1m0s
[10:31:52.339] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:25:0)
[10:31:52.339] Timer tick, asking Buildbucket for the build status
[10:31:52.417] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:31:52.417] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:26:0) after 1m0s
[10:32:52.478] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:26:0)
[10:32:52.478] Timer tick, asking Buildbucket for the build status
[10:32:52.548] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:32:52.548] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:27:0) after 1m0s
[10:33:52.693] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:27:0)
[10:33:52.693] Timer tick, asking Buildbucket for the build status
[10:33:52.819] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:33:52.819] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:28:0) after 1m0s
[10:34:52.922] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:28:0)
[10:34:52.922] Timer tick, asking Buildbucket for the build status
[10:34:53.953] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:34:53.953] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:29:0) after 1m0s
[10:35:54.151] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:29:0)
[10:35:54.151] Timer tick, asking Buildbucket for the build status
[10:35:54.411] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:35:54.411] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:30:0) after 1m0s
[10:36:54.630] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:30:0)
[10:36:54.630] Timer tick, asking Buildbucket for the build status
[10:36:54.844] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:36:54.844] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:31:0) after 1m0s
[10:37:54.982] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:31:0)
[10:37:54.982] Timer tick, asking Buildbucket for the build status
[10:37:55.215] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:37:55.215] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:32:0) after 1m0s
[10:38:55.360] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:32:0)
[10:38:55.360] Timer tick, asking Buildbucket for the build status
[10:38:55.463] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:38:55.463] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:33:0) after 1m0s
[10:39:55.684] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:33:0)
[10:39:55.684] Timer tick, asking Buildbucket for the build status
[10:39:56.082] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:39:56.082] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:34:0) after 1m0s
[10:40:56.141] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:34:0)
[10:40:56.141] Timer tick, asking Buildbucket for the build status
[10:40:56.241] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:40:56.241] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:35:0) after 1m0s
[10:41:56.351] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:35:0)
[10:41:56.351] Timer tick, asking Buildbucket for the build status
[10:41:56.477] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:41:56.477] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:36:0) after 1m0s
[10:42:56.602] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:36:0)
[10:42:56.602] Timer tick, asking Buildbucket for the build status
[10:42:56.722] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:42:56.722] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:37:0) after 1m0s
[10:43:56.871] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:37:0)
[10:43:56.871] Timer tick, asking Buildbucket for the build status
[10:43:56.972] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:43:56.972] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:38:0) after 1m0s
[10:44:57.066] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:38:0)
[10:44:57.066] Timer tick, asking Buildbucket for the build status
[10:44:57.537] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:44:57.537] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:39:0) after 1m0s
[10:45:57.647] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:39:0)
[10:45:57.647] Timer tick, asking Buildbucket for the build status
[10:45:57.972] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:45:57.972] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:40:0) after 1m0s
[10:46:58.046] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:40:0)
[10:46:58.046] Timer tick, asking Buildbucket for the build status
[10:46:58.118] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:46:58.118] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:41:0) after 1m0s
[10:47:58.270] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:41:0)
[10:47:58.270] Timer tick, asking Buildbucket for the build status
[10:47:58.348] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:47:58.348] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:42:0) after 1m0s
[10:48:58.381] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:42:0)
[10:48:58.381] Timer tick, asking Buildbucket for the build status
[10:48:58.489] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:48:58.489] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:43:0) after 1m0s
[10:49:58.547] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:43:0)
[10:49:58.547] Timer tick, asking Buildbucket for the build status
[10:49:58.680] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:49:58.680] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:44:0) after 1m0s
[10:50:58.694] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:44:0)
[10:50:58.694] Timer tick, asking Buildbucket for the build status
[10:50:58.855] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:50:58.855] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:45:0) after 1m0s
[10:51:58.878] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:45:0)
[10:51:58.878] Timer tick, asking Buildbucket for the build status
[10:51:59.224] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:51:59.224] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:46:0) after 1m0s
[10:52:59.228] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:46:0)
[10:52:59.228] Timer tick, asking Buildbucket for the build status
[10:52:59.642] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:52:59.642] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:47:0) after 1m0s
[10:53:59.696] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:47:0)
[10:53:59.696] Timer tick, asking Buildbucket for the build status
[10:53:59.821] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:53:59.821] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:48:0) after 1m0s
[10:54:59.881] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:48:0)
[10:54:59.881] Timer tick, asking Buildbucket for the build status
[10:55:00.236] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:55:00.236] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:49:0) after 1m0s
[10:56:00.284] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:49:0)
[10:56:00.284] Timer tick, asking Buildbucket for the build status
[10:56:00.796] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:56:00.796] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:50:0) after 1m0s
[10:57:01.271] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:50:0)
[10:57:01.271] Timer tick, asking Buildbucket for the build status
[10:57:01.346] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:57:01.346] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:51:0) after 1m0s
[10:58:01.613] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:51:0)
[10:58:01.613] Timer tick, asking Buildbucket for the build status
[10:58:01.683] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:58:01.683] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:52:0) after 1m0s
[10:59:01.727] Handling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:52:0)
[10:59:01.727] Timer tick, asking Buildbucket for the build status
[10:59:01.939] Build 8856778415342011584: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:59:01.939] Scheduling timer "check-buildbucket-build-status" (chromium/win-asan:9022208477319426944:53:0) after 1m0s
[10:59:25.690] Received PubSub notification, asking Buildbucket for the build status
[10:59:27.310] Build 8856778415342011584: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[10:59:27.310] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1611917965005526",
"created_by": "project:chromium",
"created_ts": "1611914921395038",
"id": "8856778415342011584",
"parameters_json": "{\"builder_name\": \"win-asan\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"069b89dff7b0e7e044f3529b4e730609c0a2bfed\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"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\": \"069b89dff7b0e7e044f3529b4e730609c0a2bfed\", \"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-us-central1-b-32-1-nlke\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.memory\", \"buildername\": \"win-asan\", \"buildnumber\": 17066, \"clang_revision\": \"llvmorg-12-init-17251-g6de48655-1\", \"got_angle_revision\": \"e419222d82cff7286ccc368932bf0fbb5d31d9e9\", \"got_dawn_revision\": \"c1d3a66bd217395a501543b09c6d2c25e9d2e22e\", \"got_nacl_revision\": \"cb31feffa500401c95c6c44d88b7c358236bca36\", \"got_revision\": \"069b89dff7b0e7e044f3529b4e730609c0a2bfed\", \"got_revision_cp\": \"refs/heads/master@{#848450}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"3e9b79ff42de0f5547809354de89e24c7a439e39\", \"got_v8_revision\": \"89b433d7c3defd04809fba9deb6f8885160044a4\", \"got_v8_revision_cp\": \"refs/heads/9.0.100@{#1}\", \"got_webrtc_revision\": \"54b925cfc2cd7c2f8f83e8e484f281aa87b92dfc\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33090}\", \"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\": \"069b89dff7b0e7e044f3529b4e730609c0a2bfed\", \"swarm_hashes_refs/heads/master(at){#848450}_without_patch\": {\"absl_hardening_tests\": \"b37d986f538ac06503fe64821bedeb4b348d136a\", \"accessibility_unittests\": \"ac6d9932be2455f9d4406d7775e4c9a62581b87b\", \"angle_unittests\": \"fbe277517e8816ada397624e1363a3b75181f96f\", \"app_shell_unittests\": \"4453cbebb40f73b8bafd2b9d047aa26bd201ca8d\", \"aura_unittests\": \"00c9fef2e44807328acb2d4d42d21971fc6819b9\", \"base_unittests\": \"13106a0a44ae24cf4433287d5a35eebef413284d\", \"base_util_unittests\": \"b320fa3c57ca91c06ba222bc8969949f5dcd230e\", \"blink_common_unittests\": \"8f26e9119f18a794075ca3a15e4d278e35562557\", \"blink_fuzzer_unittests\": \"4b7e6b4ff8f7f8f3f535189682173eb018064ea5\", \"blink_heap_unittests\": \"ed97deabf7608bc00b4540a48b528a3a70daa0ac\", \"blink_platform_unittests\": \"51e23324784debb0bf1151fa4fa888c3fded92b3\", \"blink_unittests\": \"97addd47a51f30a4eb89c72ce183e8d98edcc70a\", \"boringssl_crypto_tests\": \"211ccba244f4126353be36a3b5529a93bd3bc2c6\", \"boringssl_ssl_tests\": \"7be6b29c8bc3a1a5ff5a909e35629d86e07cb501\", \"browser_switcher_bho_unittests\": \"9d76d8d00d74c7ed565775705430b31164afd5c0\", \"browser_tests\": \"08f142a6e0efc9da14a3cafcaac593e9c182d26f\", \"capture_unittests\": \"c72cc1e2334d1ec865f1c3ccbe827eb098520c32\", \"cast_unittests\": \"cf9128e7370731802e5b0af4adf81fc2a3e52e51\", \"cc_unittests\": \"7c880cba1cd3f5cf8bac684d50629e908d3d85f6\", \"chrome_app_unittests\": \"79214889363c6a123b49eff293472e73368b0308\", \"chrome_cleaner_unittests\": \"ef64fb39524fb499c5e80d75bf2edfd0bbefe3d3\", \"chrome_elf_unittests\": \"bde75c61fa8404711f155666deeb9aa912c9a1be\", \"chromedriver_unittests\": \"97c14fdd902162314e8d2ee7b68dc298d6b133af\", \"components_browsertests\": \"63026f828a4361ea0de652e9b8aa1a851207824a\", \"components_unittests\": \"f46552c3cb2c90374f4b54f15391d2f2097b5a59\", \"compositor_unittests\": \"aff79d7bd5600588c26833f1c984a84fb68e1671\", \"content_browsertests\": \"5b71cf463d5cbb2a081623fd142236684ddee881\", \"content_unittests\": \"bd9c032717e7fd995d238ff7376ee4ceeae4d670\", \"courgette_unittests\": \"1bfb1d0e68f862dc7dcd7be4576ba61ccd6c4fb8\", \"crashpad_tests\": \"0632390353276ec77bcc6b30c0474f3a803c8092\", \"cronet_tests\": \"ef585534e94c20c7d93ce11795b0fd9e6554fe57\", \"cronet_unittests\": \"2be0aa866fa3a8b001136cba01406deb87559539\", \"crypto_unittests\": \"dde9dbbdf3264e0ee8df816d1d9892db706d1327\", \"delayloads_unittests\": \"e25bd6675fc10e23a6c3dd13bf6d902bbcc45349\", \"device_unittests\": \"4e2712fe439f66efc4216e30ffdde8723421b719\", \"display_unittests\": \"8b16cb4d1c11813305c352780213b100bafc1ead\", \"elevation_service_unittests\": \"03888cf7cc5892b92e5458e4203c2abebe775907\", \"events_unittests\": \"1c0b15955a537335f5ef1595a88c4cace9b50c13\", \"extensions_browsertests\": \"094666d0c4b0b4f16e0752ac4886094e4e9d2dba\", \"extensions_unittests\": \"ee8fa9fe1334f91a73fb7ecb359382b81d67f690\", \"filesystem_service_unittests\": \"0325b2e32d1d5ecd2c0b22ffb3396a8d45fddbb9\", \"gcm_unit_tests\": \"9ac74f1711f1db1096cfbadfeaab77c53efe77ce\", \"gcp_unittests\": \"386a946817df38e744a90050435bac2ac00cf9a5\", \"gfx_unittests\": \"7e64379f2bdc1fc91d4e3752baa7702b943af935\", \"gin_unittests\": \"348f9f072b1be9f5093aef3233deeca54906f127\", \"google_apis_unittests\": \"5dbd020198238c39346522ef6cc336108e6d398d\", \"gpu_unittests\": \"21acdbf9359f93a6eb8c59592159c4e0e1631f00\", \"gwp_asan_unittests\": \"91bf834deb3d14e0366e00561a53da5f4a0f6f0a\", \"headless_browsertests\": \"d3849e5e5f3dd2c4e8caa7fb69f17d75ebe22194\", \"headless_unittests\": \"9181868ccd2dee5d34dbb40d83bf0449111ff147\", \"install_static_unittests\": \"714b7046624105a5ba3ca7013b504fe0deabd33a\", \"installer_util_unittests\": \"bf730e1960a4091d7fef91b08ab89d42e6f5bd2a\", \"interactive_ui_tests\": \"076046999486a657e0392dbc854858a340cd0b72\", \"ipc_tests\": \"cb9b11335e6d9412541225c9b9de9706fd5aba77\", \"jingle_unittests\": \"6a1c29a5aaa590f7c8513141a48c11fa1bd31775\", \"latency_unittests\": \"3ccd44b42dfbeaa6c710a22fe29331595f5d99d3\", \"libjingle_xmpp_unittests\": \"d35f6fddc123f5cc326224d8041914eb964017ee\", \"liburlpattern_unittests\": \"d24c04e04dce77a93c32c08e263d556667183fa1\", \"media_blink_unittests\": \"e2573c25b113cfcf928a4f848b86b1ccfcda00f5\", \"media_unittests\": \"ee42301e1640afab0b35abc36e57196b3d07e109\", \"message_center_unittests\": \"c25cc34e0c343bad15e7e2eea99715528d3d23b5\", \"midi_unittests\": \"2a60eb7001bb2fa118bd57ca3df3a2d9b447bef8\", \"mojo_core_unittests\": \"867fe4f89f469ca37ddf9ed5128d50869d0e81bd\", \"mojo_unittests\": \"7eb7e24264f9ce4af5b50e944024ace8d68e40f6\", \"nacl_loader_unittests\": \"095e74bf306bd5bf40bf06ae88061932ef9d6a9c\", \"native_theme_unittests\": \"7914d76ad335782c52a56d6e83faebfb99450164\", \"net_unittests\": \"15641e55fc7bef4b3cba33db01e455fe08bd85db\", \"notification_helper_unittests\": \"8d05c817812127831b058e83fc0b575680b25eda\", \"pdf_unittests\": \"a340ee4f817d41855bb7db2605b4c7315955018d\", \"perfetto_unittests\": \"20f33b4dc2ee6f5568f3264e3214e9a6f3351737\", \"ppapi_unittests\": \"97bd3909ed7dd29c8391dc3444db6da7f17bb2ff\", \"printing_unittests\": \"17818e10ee5471797ff9fe4444458095bb6dca04\", \"remoting_unittests\": \"1cf506f49db985d469397e8b91f806bda68f6e41\", \"sbox_integration_tests\": \"4e9922b4909d5f909378366931520d9adaf9e6f0\", \"sbox_unittests\": \"80de42c1f8abfe73db2ca3ab005440e008612cf4\", \"sbox_validation_tests\": \"f440f1e23afdd7389b56cbbdcbec3c7133507faa\", \"service_manager_unittests\": \"b40afaeaf65aabc122ed96933955b13ac53eff14\", \"services_unittests\": \"dd13bd368d6608b02678095d019176b72737aaf7\", \"setup_unittests\": \"d6adde07fb78d77e0df0d94b94692460da08f51f\", \"shell_dialogs_unittests\": \"9251498e90047ee79e3f8740cae0deb41f3b2ec9\", \"skia_unittests\": \"ee402140953c516a1960d95d7c5b3c12b55524ab\", \"snapshot_unittests\": \"8b177ce122edc27bad0dba9f7d7038568066bbb1\", \"sql_unittests\": \"6b8033a88f4f908578c64d4276f74f2078576887\", \"storage_unittests\": \"f12a59c5b6b16a8db05cc167d418abbaeb996df2\", \"sync_integration_tests\": \"9f47cbd95b6cc113b9f25a2b003e8a7b5440f47a\", \"traffic_annotation_auditor_unittests\": \"c65e6d09803772160897496a71dab0650c10de2a\", \"ui_base_unittests\": \"97f4eded2d475604bed1f9c6de51d5f4dc285880\", \"ui_touch_selection_unittests\": \"7593f539654340919d6f5220aaaf849de0e434f8\", \"unit_tests\": \"2a3e69bdda6d63274f0a79a888216f04e5561014\", \"updater_tests\": \"c72691f8e4f19f05cebfb4c67d139743ddd6f75a\", \"url_unittests\": \"fbeab7030b21cd3bb131e540a4339369ce611821\", \"views_unittests\": \"3dd4792b2eff8c3c3a03ae563f6ecb39173113f2\", \"viz_unittests\": \"a60c2a0839f58e45ef3ee580a9e7229c633844f3\", \"vr_common_unittests\": \"b26a4e3a557472dec5cad69cf9d1fb2713965a50\", \"vr_pixeltests\": \"c87763ab4bbd0ff2a1a732b3601b6ac7dd2919ce\", \"weblayer_browsertests\": \"d013ebe1d5efa3f84c42d817797e1cf26a1143a2\", \"weblayer_unittests\": \"7cb049d050bdb9832421a079f7283df57c4b04e8\", \"wm_unittests\": \"28f886648bc2d48ee17933e3f9d7be61878fee5c\", \"wtf_unittests\": \"defa9e434756e7451569e1324dbbbe0db942acc0\", \"zlib_unittests\": \"714f612a926c317deb380452bb2b86072b244e33\", \"zucchini_unittests\": \"f5dcd2521f461785c9e92b172f76f787cd151b84\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_ba2591630e3c492a7f8bed019e3d41c3ae1f8879793a1bf71c3be1367a2696d6_v2\", \"builder_c244a7c1904bb59c4b6cd021ade0aa3730bbe3d07abc076b32cf6cdc63527337_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-win10-us-central1-b-32-1-nlke\"], \"image\": [\"chrome-win10-1703-20111600-a937a23cefb\"], \"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\": [\"5673-2413400\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1611914925176330",
"status": "COMPLETED",
"status_changed_ts": "1611917965238076",
"tags": [
"build_address:luci.chromium.ci/win-asan/17066",
"builder:win-asan",
"buildset:commit/git/069b89dff7b0e7e044f3529b4e730609c0a2bfed",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/069b89dff7b0e7e044f3529b4e730609c0a2bfed",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9022208477319426944",
"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/8856778415342011584/+/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:51666f50420b4e10",
"user_agent:luci-scheduler"
],
"updated_ts": "1611917965243528",
"url": "https://ci.chromium.org/b/8856778415342011584",
"utcnow_ts": "1611917967292690"
}
}
[10:59:27.310] Invocation finished in 50m47.184899688s with status SUCCEEDED