[20:34:48.850] New invocation is queued and will start shortly
[20:34:49.997] Starting the invocation (attempt 1)
[20:34:50.034] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[20:34:50.034] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[20:34:50.034] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9020900726142289056",
"parameters_json": "{\"builder_name\":\"linux-chromeos-rel\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"8071761dbfc0f82827c27d9d2a7a68daafa6dfd5\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-rel",
"scheduler_invocation_id:9020900726142289056",
"scheduler_job_id:chromium/linux-chromeos-rel",
"user_agent:luci-scheduler",
"buildset:commit/git/8071761dbfc0f82827c27d9d2a7a68daafa6dfd5",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/8071761dbfc0f82827c27d9d2a7a68daafa6dfd5",
"gitiles_ref:refs/heads/master"
]
}
[20:34:50.630] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1613162090123396",
"id": "8855470664145434944",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"8071761dbfc0f82827c27d9d2a7a68daafa6dfd5\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1613162090506598",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/45372",
"builder:linux-chromeos-rel",
"buildset:commit/git/8071761dbfc0f82827c27d9d2a7a68daafa6dfd5",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/8071761dbfc0f82827c27d9d2a7a68daafa6dfd5",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9020900726142289056",
"scheduler_job_id:chromium/linux-chromeos-rel",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8855470664145434944/+/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": "1613162090506829",
"url": "https://ci.chromium.org/b/8855470664145434944",
"utcnow_ts": "1613162090623115"
}
}
[20:34:50.630] Task URL: https://ci.chromium.org/b/8855470664145434944
[20:34:50.630] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:2:0) after 1m0s
[20:35:12.412] Received PubSub notification, asking Buildbucket for the build status
[20:35:12.480] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:35:50.649] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:2:0)
[20:35:50.649] Timer tick, asking Buildbucket for the build status
[20:35:50.746] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:35:50.746] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:4:0) after 1m0s
[20:36:50.883] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:4:0)
[20:36:50.883] Timer tick, asking Buildbucket for the build status
[20:36:51.139] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:36:51.139] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:5:0) after 1m0s
[20:37:51.328] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:5:0)
[20:37:51.329] Timer tick, asking Buildbucket for the build status
[20:37:51.422] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:37:51.422] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:6:0) after 1m0s
[20:38:51.511] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:6:0)
[20:38:51.511] Timer tick, asking Buildbucket for the build status
[20:38:51.605] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:38:51.605] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:7:0) after 1m0s
[20:39:51.656] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:7:0)
[20:39:51.656] Timer tick, asking Buildbucket for the build status
[20:39:51.753] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:39:51.753] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:8:0) after 1m0s
[20:40:51.811] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:8:0)
[20:40:51.811] Timer tick, asking Buildbucket for the build status
[20:40:51.946] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:40:51.946] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:9:0) after 1m0s
[20:41:51.953] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:9:0)
[20:41:51.953] Timer tick, asking Buildbucket for the build status
[20:41:52.032] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:41:52.032] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:10:0) after 1m0s
[20:42:52.052] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:10:0)
[20:42:52.052] Timer tick, asking Buildbucket for the build status
[20:42:52.167] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:42:52.167] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:11:0) after 1m0s
[20:43:52.231] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:11:0)
[20:43:52.231] Timer tick, asking Buildbucket for the build status
[20:43:52.329] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:43:52.329] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:12:0) after 1m0s
[20:44:52.415] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:12:0)
[20:44:52.415] Timer tick, asking Buildbucket for the build status
[20:44:52.549] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:44:52.549] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:13:0) after 1m0s
[20:45:52.704] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:13:0)
[20:45:52.704] Timer tick, asking Buildbucket for the build status
[20:45:52.787] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:45:52.787] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:14:0) after 1m0s
[20:46:52.847] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:14:0)
[20:46:52.847] Timer tick, asking Buildbucket for the build status
[20:46:52.977] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:46:52.977] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:15:0) after 1m0s
[20:47:53.026] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:15:0)
[20:47:53.026] Timer tick, asking Buildbucket for the build status
[20:47:53.106] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:47:53.106] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:16:0) after 1m0s
[20:48:53.258] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:16:0)
[20:48:53.258] Timer tick, asking Buildbucket for the build status
[20:48:53.371] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:48:53.371] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:17:0) after 1m0s
[20:49:53.493] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:17:0)
[20:49:53.493] Timer tick, asking Buildbucket for the build status
[20:49:53.936] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:49:53.936] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:18:0) after 1m0s
[20:50:54.052] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:18:0)
[20:50:54.052] Timer tick, asking Buildbucket for the build status
[20:50:54.166] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:50:54.166] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:19:0) after 1m0s
[20:51:54.222] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:19:0)
[20:51:54.222] Timer tick, asking Buildbucket for the build status
[20:51:54.340] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:51:54.340] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:20:0) after 1m0s
[20:52:54.335] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:20:0)
[20:52:54.335] Timer tick, asking Buildbucket for the build status
[20:52:54.441] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:52:54.441] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:21:0) after 1m0s
[20:53:54.448] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:21:0)
[20:53:54.448] Timer tick, asking Buildbucket for the build status
[20:53:54.570] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:53:54.570] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:22:0) after 1m0s
[20:54:54.589] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:22:0)
[20:54:54.589] Timer tick, asking Buildbucket for the build status
[20:54:54.711] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:54:54.711] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:23:0) after 1m0s
[20:55:54.761] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:23:0)
[20:55:54.761] Timer tick, asking Buildbucket for the build status
[20:55:54.872] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:55:54.872] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:24:0) after 1m0s
[20:56:54.995] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:24:0)
[20:56:54.995] Timer tick, asking Buildbucket for the build status
[20:56:55.076] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:56:55.076] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:25:0) after 1m0s
[20:57:55.110] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:25:0)
[20:57:55.110] Timer tick, asking Buildbucket for the build status
[20:57:55.276] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:57:55.276] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:26:0) after 1m0s
[20:58:55.286] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:26:0)
[20:58:55.286] Timer tick, asking Buildbucket for the build status
[20:58:55.417] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:58:55.417] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:27:0) after 1m0s
[20:59:55.775] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:27:0)
[20:59:55.775] Timer tick, asking Buildbucket for the build status
[20:59:55.877] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:59:55.877] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:28:0) after 1m0s
[21:00:56.052] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:28:0)
[21:00:56.053] Timer tick, asking Buildbucket for the build status
[21:00:57.453] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:00:57.453] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:29:0) after 1m0s
[21:01:57.470] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:29:0)
[21:01:57.470] Timer tick, asking Buildbucket for the build status
[21:01:57.560] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:01:57.560] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:30:0) after 1m0s
[21:02:57.665] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:30:0)
[21:02:57.665] Timer tick, asking Buildbucket for the build status
[21:02:57.803] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:02:57.803] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:31:0) after 1m0s
[21:03:58.025] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:31:0)
[21:03:58.025] Timer tick, asking Buildbucket for the build status
[21:03:58.107] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:03:58.107] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:32:0) after 1m0s
[21:04:58.301] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:32:0)
[21:04:58.301] Timer tick, asking Buildbucket for the build status
[21:04:58.606] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:04:58.606] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:33:0) after 1m0s
[21:05:58.730] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:33:0)
[21:05:58.730] Timer tick, asking Buildbucket for the build status
[21:05:58.854] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:05:58.854] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:34:0) after 1m0s
[21:06:58.887] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:34:0)
[21:06:58.887] Timer tick, asking Buildbucket for the build status
[21:06:58.973] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:06:58.973] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:35:0) after 1m0s
[21:07:58.999] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:35:0)
[21:07:58.999] Timer tick, asking Buildbucket for the build status
[21:07:59.127] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:07:59.127] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:36:0) after 1m0s
[21:08:59.257] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:36:0)
[21:08:59.257] Timer tick, asking Buildbucket for the build status
[21:08:59.685] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:08:59.685] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:37:0) after 1m0s
[21:09:59.761] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:37:0)
[21:09:59.761] Timer tick, asking Buildbucket for the build status
[21:09:59.939] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:09:59.939] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:38:0) after 1m0s
[21:11:00.112] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:38:0)
[21:11:00.112] Timer tick, asking Buildbucket for the build status
[21:11:00.360] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:11:00.360] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:39:0) after 1m0s
[21:12:00.444] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:39:0)
[21:12:00.444] Timer tick, asking Buildbucket for the build status
[21:12:00.684] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:12:00.684] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:40:0) after 1m0s
[21:13:00.905] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:40:0)
[21:13:00.905] Timer tick, asking Buildbucket for the build status
[21:13:01.006] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:13:01.006] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:41:0) after 1m0s
[21:14:01.171] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:41:0)
[21:14:01.171] Timer tick, asking Buildbucket for the build status
[21:14:01.275] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:14:01.275] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:42:0) after 1m0s
[21:15:01.509] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:42:0)
[21:15:01.509] Timer tick, asking Buildbucket for the build status
[21:15:01.691] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:15:01.691] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:43:0) after 1m0s
[21:16:01.978] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:43:0)
[21:16:01.978] Timer tick, asking Buildbucket for the build status
[21:16:02.065] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:16:02.066] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:44:0) after 1m0s
[21:17:02.225] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:44:0)
[21:17:02.225] Timer tick, asking Buildbucket for the build status
[21:17:02.326] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:17:02.326] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:45:0) after 1m0s
[21:18:02.510] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:45:0)
[21:18:02.510] Timer tick, asking Buildbucket for the build status
[21:18:02.672] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:18:02.672] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:46:0) after 1m0s
[21:19:02.723] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:46:0)
[21:19:02.723] Timer tick, asking Buildbucket for the build status
[21:19:02.887] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:19:02.887] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:47:0) after 1m0s
[21:20:02.952] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:47:0)
[21:20:02.952] Timer tick, asking Buildbucket for the build status
[21:20:03.319] Build 8855470664145434944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:20:03.319] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9020900726142289056:48:0) after 1m0s
[21:20:48.754] Received PubSub notification, asking Buildbucket for the build status
[21:20:48.867] Build 8855470664145434944: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[21:20:48.867] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1613164847850255",
"created_by": "project:chromium",
"created_ts": "1613162090123396",
"id": "8855470664145434944",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"8071761dbfc0f82827c27d9d2a7a68daafa6dfd5\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"enable_ats\": true, \"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\": \"8071761dbfc0f82827c27d9d2a7a68daafa6dfd5\", \"project\": \"chromium/src\"}], \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"luci-chromium-ci-xenial-us-central1-b-8-174-1mmr\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-rel\", \"buildnumber\": 45372, \"got_angle_revision\": \"a8a2a71b3ab5e535def6239997f6f24da918556b\", \"got_dawn_revision\": \"d44159c23c104746dd12b35d251922d89d45f4e8\", \"got_nacl_revision\": \"82ac8c0a6f0d3ffc843c693dd5149a356b866ae5\", \"got_revision\": \"8071761dbfc0f82827c27d9d2a7a68daafa6dfd5\", \"got_revision_cp\": \"refs/heads/master@{#853651}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"0bcb71f9c7372af4a5a56c02cf23775606f789a6\", \"got_v8_revision\": \"260bcd21bdd03c9b69640107ae221492fd04c744\", \"got_v8_revision_cp\": \"refs/heads/9.0.169@{#1}\", \"got_webrtc_revision\": \"f28d7e89b7a3c985d83f59d16b9f3c3f45ef7997\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33224}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mirrored_builders\": [\"tryserver.chromium.chromiumos:linux-chromeos-inverse-fieldtrials-fyi-rel\", \"tryserver.chromium.chromiumos:linux-chromeos-rel\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"8071761dbfc0f82827c27d9d2a7a68daafa6dfd5\", \"swarm_hashes_refs/heads/master(at){#853651}_without_patch\": {\"absl_hardening_tests\": \"ad367ba12898ce5ba1550f3b5ecc956e37be8113\", \"accessibility_unittests\": \"1be8251f4bacd07eebcb811700480659b7531f12\", \"angle_unittests\": \"d01de3ba1dec633a30127754d12862131b3c7ba6\", \"app_list_unittests\": \"aad0dfd7087a18701e4f73f6a0e0958f1461e7a7\", \"app_shell_unittests\": \"39548b00e6968d5a9940a4a283d759115c6ece3b\", \"ash_unittests\": \"572371c4367f922acf747956c9d4d5dd84c657d0\", \"aura_unittests\": \"b999a8fbb904ce54cfb21fd21e3baba654dd662b\", \"base_unittests\": \"1de6088bbc40923c2ec963fbed012a456e8eff00\", \"base_util_unittests\": \"832101d13169549fc20856b2ba135c23e75273a5\", \"blink_common_unittests\": \"0729f1cdf7dbe8465576550260e0b349fdda1b0e\", \"blink_fuzzer_unittests\": \"93808e108968f18621d2ee31c8085c9aa5e99da2\", \"blink_heap_unittests\": \"6eba896611559c7e505b85df07293a5a00159099\", \"blink_platform_unittests\": \"ab8e602dd8bdfb66a07158795d19f61dbbf531a4\", \"blink_unittests\": \"f5689c5d539080716b7d4ff4b0826ed442b18191\", \"boringssl_crypto_tests\": \"d55979254ffee3e1706f90fa6e7f7667601f23cd\", \"boringssl_ssl_tests\": \"ec19568baa40555d20df9d751be6dfb2695fba28\", \"browser_tests\": \"de23552522034c9c8726bc1006eca576a2d8cce1\", \"capture_unittests\": \"3ace31f0d04d83405f02991e865051122ff943b2\", \"cast_unittests\": \"2cab2e6a5ec9fc478b3a9a5bd2bf1c30a7b0f008\", \"cc_unittests\": \"b6dc3ae31e0a31ced313ad0e212e018ca455014c\", \"chrome_app_unittests\": \"2b1a76e24d27915c13696b86b1220a1579111c33\", \"chromedriver_unittests\": \"c16251adc3b5a1cfee269dfeb0659287d9933279\", \"chromeos_components_unittests\": \"6e9c332d07b472c5ee72ce106d06448ded6fa1da\", \"chromeos_unittests\": \"dbe3eaf28f16d89973b01c73f54f9da411a9ba7d\", \"components_browsertests\": \"f7f1d1ec6be34040af6867cc94f97d071e481d7d\", \"components_unittests\": \"df9dff527b6b42c805029525db431a95b2a8e386\", \"compositor_unittests\": \"d544d770a1c47fe48f03122ad40ecc420471d17d\", \"content_browsertests\": \"38efe32ecacc03f5d845f90aab6e033172e8f471\", \"content_unittests\": \"e044ce1bf34948f5083dd24eb7fdf860b09887f9\", \"crashpad_tests\": \"2f48b1ad65c7ba983ee6a0b76524f9062b2d2582\", \"crypto_unittests\": \"36cc926985e72e991f5ca62c4289e429fa29a5b8\", \"dbus_unittests\": \"f6dc0d601b8d8242b9f516991f5c3a5edd96cf90\", \"device_unittests\": \"1ed4e892eb311db324d4c78df6d4c928b5b66b81\", \"display_unittests\": \"ad1bd88db03aa0bb8cfdc84898047477767ab563\", \"events_unittests\": \"059b0b7740e0de9302985b9231fea3b2376fea10\", \"exo_unittests\": \"738f1cc2f9c94b9e46f11dfdce0d22a516054ddc\", \"extensions_browsertests\": \"73fc206f7ad5fa38ac52f7618957ef02405be81b\", \"extensions_unittests\": \"98d822bc40053d8120804081d23a95579dc421f1\", \"filesystem_service_unittests\": \"71fb6a74c3a4b595afa22e44d9ab2eedde652845\", \"gcm_unit_tests\": \"be1e805ad27e3aa38aea5ba0b00d967d549ec1cb\", \"gfx_unittests\": \"d6bd1ede81a26072361893f677cbbc7f8e3493b3\", \"gin_unittests\": \"8772b225cde2b0b7b4a684430d597a8cfe28aa5f\", \"gl_unittests_ozone\": \"06b3fd2f9688ab851f1c214726c5ba3cef236bb5\", \"google_apis_unittests\": \"8da758a6172f77fe3169201b2b2579b6861485db\", \"gpu_unittests\": \"fe7e8ab94a4a17b56c4ce4512968e1265843eb1d\", \"gwp_asan_unittests\": \"851adb88371aed624a1618039f6d71e98f56fc6f\", \"interactive_ui_tests\": \"fd3497dee141ec67086934541f77264a36c55699\", \"ipc_tests\": \"ef436d5f74c70ad09d8744e708d4434768b39141\", \"jingle_unittests\": \"bf070a51b6d6852c625555cf87476e41219be2b3\", \"keyboard_unittests\": \"9b16b5af3eb7222ddbd41e6e134837bc3ea996ce\", \"latency_unittests\": \"459469f4fc5c0eaa371b35ecda5601649d7fdef2\", \"libjingle_xmpp_unittests\": \"b0209f3e6fa830aa977082f1c1b7c0f476fa2390\", \"liburlpattern_unittests\": \"2a5b3caed8f7021a40fe2a25e3c03ee704f5fa27\", \"media_blink_unittests\": \"d2526a71a0a92d8ec7f7a9dd7a0360235cc1c5a0\", \"media_unittests\": \"300822f305365eb1119d2519da497a3700737c68\", \"message_center_unittests\": \"3b2cf3e484f553fdb4e375ab6ccfdba8bda7aede\", \"midi_unittests\": \"cc07b3661bd5745362460ae78245a7062930e824\", \"mojo_core_unittests\": \"d04337af6dcbea3aed3957ef505e8648e7fd7a02\", \"mojo_unittests\": \"99641fddf5f09375521bd0152b11844ab3735a88\", \"nacl_helper_nonsfi_unittests\": \"787fe4619ab2ed3813304955c2a00532b18131fe\", \"nacl_loader_unittests\": \"7f9f2a615ec8ddf0bb869e4003d44b93b11c7a1d\", \"native_theme_unittests\": \"6a419006c6e254a86ec6ee792d01bd3c2ab3afa0\", \"net_unittests\": \"5b37a0edde205aa208f6b41812824c3030329b41\", \"ozone_gl_unittests\": \"1274d5943204e236d143aaaf8a6ef76900ac6db9\", \"ozone_unittests\": \"a1a40b288dd7fb480360b5e214b2df51e28035b5\", \"ozone_x11_unittests\": \"aa18211e0f7bfb8ce473447d610e63355ed83de9\", \"pdf_unittests\": \"7d3caf8053108d2fccbfae9d03e39e957af67e7e\", \"perfetto_unittests\": \"7de2b2eb962598d11510476120f2dd93d5d335b6\", \"ppapi_unittests\": \"b54dc8144d5ade8b36ccaa0563f5890778f99106\", \"printing_unittests\": \"13a71edd7e419495e880b7afcab49a9aa2f4a838\", \"remoting_unittests\": \"218947ae414c22630799295a000f54200f88f493\", \"sandbox_linux_unittests\": \"bc1b24adeb65d61db9095b11c429f5b967973103\", \"service_manager_unittests\": \"b0b9543fdb332edef8ffbc931ccfdd69fbb2b60b\", \"services_unittests\": \"b7391946f1a1a4bbac0abc65f6b4f8b61c348855\", \"shell_dialogs_unittests\": \"5add6645701f6d31d5f9b7c1f2da9bce4ba07ef5\", \"shell_encryption_unittests\": \"864e73e15c14fc85be50b97d15913fe6c68cfb11\", \"skia_unittests\": \"2c5597f689ea9379f1783622c95dff33e8b751f7\", \"snapshot_unittests\": \"d9dbed096ddc6b8e1844534e811172b8999684fe\", \"sql_unittests\": \"ab033a454dcf831a219dd31e4a754fc80ee45961\", \"storage_unittests\": \"cba98bfb6e3d7517f02362a3be10b6e7e3a0847c\", \"sync_integration_tests\": \"e4cabe574c276286101da36413f13206a825cf57\", \"traffic_annotation_auditor_unittests\": \"3d8186a9a53b3ff6c5a1fce0739e1144e3ec81ed\", \"ui_base_unittests\": \"213c44a569242ce10cd2b6e691a5a420a4764aa4\", \"ui_chromeos_unittests\": \"f2fd0dcd5a050c60014248f3134f3a37b7251c28\", \"ui_touch_selection_unittests\": \"a23ea6f6fbb9f88d5de820be0ab46c43d464390a\", \"unit_tests\": \"fb55c999dc38797c49416a820afb4ace294c7845\", \"url_unittests\": \"b26014b2035e4c683a3678dbe10af35dcad562f0\", \"usage_time_limit_unittests\": \"05588d0504255c29d41c37cd260f9b072135bcdd\", \"views_unittests\": \"17dfa380d1b998cf4c3dd13812606e65ab99acf3\", \"viz_unittests\": \"f12704df945038b0c0ac948f312abf31da9ee696\", \"wayland_client_perftests\": \"23343f5533605be3a5037758d91c9ff4f362c78a\", \"wm_unittests\": \"78fe66d6f0edf8030a829f9e1c929113e6539d20\", \"wtf_unittests\": \"5c1b116eae1872ec6f8731e6aa1eb9503a53e66b\", \"zlib_unittests\": \"440816716108c0f57c2460c0734a817a6320c1c4\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_94fa3119a28f4651cdd4fc5b981a64c69b26c151212072333439362290628993_v2\", \"builder_9f247f4686c5cf47ea762220cc037b3e853f43c1442c10d387faa806e919f9a9_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-b-8-174-1mmr\"], \"image\": [\"chrome-xenial-21011100-9488e34e558\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16\", \"Ubuntu-16.04\", \"Ubuntu-16.04.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5690-40331dd\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1613162111548422",
"status": "COMPLETED",
"status_changed_ts": "1613164848312256",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/45372",
"builder:linux-chromeos-rel",
"buildset:commit/git/8071761dbfc0f82827c27d9d2a7a68daafa6dfd5",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/8071761dbfc0f82827c27d9d2a7a68daafa6dfd5",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9020900726142289056",
"scheduler_job_id:chromium/linux-chromeos-rel",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8855470664145434944/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:51b0c5999a7b1710",
"user_agent:luci-scheduler"
],
"updated_ts": "1613164848317170",
"url": "https://ci.chromium.org/b/8855470664145434944",
"utcnow_ts": "1613164848849680"
}
}
[21:20:48.868] Invocation finished in 46m0.033205505s with status SUCCEEDED