[07:56:57.308] New invocation is queued and will start shortly
[07:56:58.604] Starting the invocation (attempt 1)
[07:56:58.644] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[07:56:58.644] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[07:56:58.645] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9027924372926320384",
"parameters_json": "{\"builder_name\":\"linux-chromeos-rel\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"32d461a269235bc172c5e59a2526272c4ff04a49\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-rel",
"scheduler_invocation_id:9027924372926320384",
"scheduler_job_id:chromium/linux-chromeos-rel",
"user_agent:luci-scheduler",
"buildset:commit/git/32d461a269235bc172c5e59a2526272c4ff04a49",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/32d461a269235bc172c5e59a2526272c4ff04a49",
"gitiles_ref:refs/heads/master"
]
}
[07:56:59.355] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1606463818729069",
"id": "8862494310770637152",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"32d461a269235bc172c5e59a2526272c4ff04a49\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1606463819113358",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/43231",
"builder:linux-chromeos-rel",
"buildset:commit/git/32d461a269235bc172c5e59a2526272c4ff04a49",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/32d461a269235bc172c5e59a2526272c4ff04a49",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9027924372926320384",
"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/8862494310770637152/+/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": "1606463819113485",
"url": "https://ci.chromium.org/b/8862494310770637152",
"utcnow_ts": "1606463819339305"
}
}
[07:56:59.355] Task URL: https://ci.chromium.org/b/8862494310770637152
[07:56:59.355] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:2:0) after 1m0s
[07:57:00.770] Received PubSub notification, asking Buildbucket for the build status
[07:57:00.867] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:57:59.427] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:2:0)
[07:57:59.427] Timer tick, asking Buildbucket for the build status
[07:57:59.522] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:57:59.522] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:4:0) after 1m0s
[07:58:59.603] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:4:0)
[07:58:59.603] Timer tick, asking Buildbucket for the build status
[07:58:59.720] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:58:59.720] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:5:0) after 1m0s
[07:59:59.734] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:5:0)
[07:59:59.734] Timer tick, asking Buildbucket for the build status
[07:59:59.859] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:59:59.859] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:6:0) after 1m0s
[08:00:59.881] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:6:0)
[08:00:59.881] Timer tick, asking Buildbucket for the build status
[08:01:00.189] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:01:00.189] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:7:0) after 1m0s
[08:02:00.185] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:7:0)
[08:02:00.185] Timer tick, asking Buildbucket for the build status
[08:02:00.458] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:02:00.458] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:8:0) after 1m0s
[08:03:00.497] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:8:0)
[08:03:00.497] Timer tick, asking Buildbucket for the build status
[08:03:00.614] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:03:00.614] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:9:0) after 1m0s
[08:04:01.004] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:9:0)
[08:04:01.004] Timer tick, asking Buildbucket for the build status
[08:04:01.143] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:04:01.143] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:10:0) after 1m0s
[08:05:02.583] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:10:0)
[08:05:02.583] Timer tick, asking Buildbucket for the build status
[08:05:02.729] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:05:02.729] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:11:0) after 1m0s
[08:06:03.018] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:11:0)
[08:06:03.018] Timer tick, asking Buildbucket for the build status
[08:06:03.114] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:06:03.114] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:12:0) after 1m0s
[08:07:03.166] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:12:0)
[08:07:03.166] Timer tick, asking Buildbucket for the build status
[08:07:03.449] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:07:03.449] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:13:0) after 1m0s
[08:08:03.469] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:13:0)
[08:08:03.469] Timer tick, asking Buildbucket for the build status
[08:08:03.530] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:08:03.530] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:14:0) after 1m0s
[08:09:03.621] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:14:0)
[08:09:03.621] Timer tick, asking Buildbucket for the build status
[08:09:03.896] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:09:03.896] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:15:0) after 1m0s
[08:10:03.934] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:15:0)
[08:10:03.934] Timer tick, asking Buildbucket for the build status
[08:10:04.209] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:10:04.209] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:16:0) after 1m0s
[08:11:04.247] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:16:0)
[08:11:04.247] Timer tick, asking Buildbucket for the build status
[08:11:04.363] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:11:04.363] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:17:0) after 1m0s
[08:12:04.381] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:17:0)
[08:12:04.381] Timer tick, asking Buildbucket for the build status
[08:12:04.999] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:12:04.999] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:18:0) after 1m0s
[08:13:05.021] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:18:0)
[08:13:05.021] Timer tick, asking Buildbucket for the build status
[08:13:05.318] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:13:05.318] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:19:0) after 1m0s
[08:14:05.580] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:19:0)
[08:14:05.580] Timer tick, asking Buildbucket for the build status
[08:14:06.199] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:14:06.200] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:20:0) after 1m0s
[08:15:06.297] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:20:0)
[08:15:06.297] Timer tick, asking Buildbucket for the build status
[08:15:06.407] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:15:06.407] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:21:0) after 1m0s
[08:16:06.427] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:21:0)
[08:16:06.427] Timer tick, asking Buildbucket for the build status
[08:16:06.506] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:16:06.506] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:22:0) after 1m0s
[08:17:06.558] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:22:0)
[08:17:06.558] Timer tick, asking Buildbucket for the build status
[08:17:06.682] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:17:06.682] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:23:0) after 1m0s
[08:18:06.701] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:23:0)
[08:18:06.701] Timer tick, asking Buildbucket for the build status
[08:18:06.959] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:18:06.959] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:24:0) after 1m0s
[08:19:07.003] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:24:0)
[08:19:07.003] Timer tick, asking Buildbucket for the build status
[08:19:07.069] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:19:07.069] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:25:0) after 1m0s
[08:20:07.201] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:25:0)
[08:20:07.201] Timer tick, asking Buildbucket for the build status
[08:20:07.322] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:20:07.323] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:26:0) after 1m0s
[08:21:07.342] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:26:0)
[08:21:07.342] Timer tick, asking Buildbucket for the build status
[08:21:07.507] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:21:07.507] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:27:0) after 1m0s
[08:22:07.563] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:27:0)
[08:22:07.563] Timer tick, asking Buildbucket for the build status
[08:22:07.686] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:22:07.686] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:28:0) after 1m0s
[08:23:07.715] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:28:0)
[08:23:07.715] Timer tick, asking Buildbucket for the build status
[08:23:07.837] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:23:07.838] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:29:0) after 1m0s
[08:24:07.861] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:29:0)
[08:24:07.861] Timer tick, asking Buildbucket for the build status
[08:24:07.925] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:24:07.925] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:30:0) after 1m0s
[08:25:07.905] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:30:0)
[08:25:07.905] Timer tick, asking Buildbucket for the build status
[08:25:08.081] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:25:08.081] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:31:0) after 1m0s
[08:26:08.276] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:31:0)
[08:26:08.276] Timer tick, asking Buildbucket for the build status
[08:26:08.339] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:26:08.339] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:32:0) after 1m0s
[08:27:08.392] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:32:0)
[08:27:08.392] Timer tick, asking Buildbucket for the build status
[08:27:08.536] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:27:08.536] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:33:0) after 1m0s
[08:28:08.559] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:33:0)
[08:28:08.559] Timer tick, asking Buildbucket for the build status
[08:28:09.051] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:28:09.051] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:34:0) after 1m0s
[08:29:09.106] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:34:0)
[08:29:09.106] Timer tick, asking Buildbucket for the build status
[08:29:09.191] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:29:09.191] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:35:0) after 1m0s
[08:30:09.218] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:35:0)
[08:30:09.218] Timer tick, asking Buildbucket for the build status
[08:30:09.442] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:30:09.442] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:36:0) after 1m0s
[08:31:09.469] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:36:0)
[08:31:09.469] Timer tick, asking Buildbucket for the build status
[08:31:09.647] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:31:09.647] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:37:0) after 1m0s
[08:32:09.652] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:37:0)
[08:32:09.652] Timer tick, asking Buildbucket for the build status
[08:32:09.807] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:32:09.807] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:38:0) after 1m0s
[08:33:09.857] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:38:0)
[08:33:09.857] Timer tick, asking Buildbucket for the build status
[08:33:10.349] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:33:10.349] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:39:0) after 1m0s
[08:34:10.406] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:39:0)
[08:34:10.406] Timer tick, asking Buildbucket for the build status
[08:34:10.549] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:34:10.549] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:40:0) after 1m0s
[08:35:10.578] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:40:0)
[08:35:10.578] Timer tick, asking Buildbucket for the build status
[08:35:10.637] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:35:10.637] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:41:0) after 1m0s
[08:36:10.660] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:41:0)
[08:36:10.660] Timer tick, asking Buildbucket for the build status
[08:36:10.933] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:36:10.933] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:42:0) after 1m0s
[08:37:10.955] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:42:0)
[08:37:10.955] Timer tick, asking Buildbucket for the build status
[08:37:11.161] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:37:11.161] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:43:0) after 1m0s
[08:38:11.200] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:43:0)
[08:38:11.200] Timer tick, asking Buildbucket for the build status
[08:38:11.385] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:38:11.385] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:44:0) after 1m0s
[08:39:11.408] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:44:0)
[08:39:11.408] Timer tick, asking Buildbucket for the build status
[08:39:11.527] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:39:11.527] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:45:0) after 1m0s
[08:40:11.555] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:45:0)
[08:40:11.555] Timer tick, asking Buildbucket for the build status
[08:40:11.816] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:40:11.816] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:46:0) after 1m0s
[08:41:11.898] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:46:0)
[08:41:11.898] Timer tick, asking Buildbucket for the build status
[08:41:12.252] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:41:12.252] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:47:0) after 1m0s
[08:42:12.272] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:47:0)
[08:42:12.272] Timer tick, asking Buildbucket for the build status
[08:42:12.754] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:42:12.754] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:48:0) after 1m0s
[08:43:12.783] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:48:0)
[08:43:12.783] Timer tick, asking Buildbucket for the build status
[08:43:12.927] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:43:12.927] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:49:0) after 1m0s
[08:44:12.951] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:49:0)
[08:44:12.951] Timer tick, asking Buildbucket for the build status
[08:44:13.096] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:44:13.096] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:50:0) after 1m0s
[08:45:13.154] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:50:0)
[08:45:13.154] Timer tick, asking Buildbucket for the build status
[08:45:13.544] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:45:13.544] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:51:0) after 1m0s
[08:46:13.716] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:51:0)
[08:46:13.716] Timer tick, asking Buildbucket for the build status
[08:46:13.848] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:46:13.848] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:52:0) after 1m0s
[08:47:13.878] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:52:0)
[08:47:13.878] Timer tick, asking Buildbucket for the build status
[08:47:13.993] Build 8862494310770637152: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:47:13.993] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027924372926320384:53:0) after 1m0s
[08:47:44.577] Received PubSub notification, asking Buildbucket for the build status
[08:47:44.731] Build 8862494310770637152: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[08:47:44.731] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1606466863102844",
"created_by": "project:chromium",
"created_ts": "1606463818729069",
"id": "8862494310770637152",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"32d461a269235bc172c5e59a2526272c4ff04a49\"}}",
"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\": \"32d461a269235bc172c5e59a2526272c4ff04a49\", \"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-216-medw\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-rel\", \"buildnumber\": 43231, \"got_angle_revision\": \"fcb6b5a5c55ee35d232f35bcfa9c35aefc00f89e\", \"got_dawn_revision\": \"4814bdbdeae40186a61dfb7494390e64820daa4f\", \"got_nacl_revision\": \"3ac0b060c794b64531b47dfded8ff8d951a5c648\", \"got_revision\": \"32d461a269235bc172c5e59a2526272c4ff04a49\", \"got_revision_cp\": \"refs/heads/master@{#831499}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"9dff6a3bb5950edd890e5141f2d3d2f3b4ef351e\", \"got_v8_revision\": \"961f93287f84e7e7a7f5ff8a43c7adf14ca7fc42\", \"got_v8_revision_cp\": \"refs/heads/8.9.63@{#1}\", \"got_webrtc_revision\": \"0d863f72a8c747c1b41f2798e5201e1abcdaec2b\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32704}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mirrored_builders\": [\"tryserver.chromium.chromiumos:linux-chromeos-rel\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"32d461a269235bc172c5e59a2526272c4ff04a49\", \"swarm_hashes_refs/heads/master(at){#831499}_without_patch\": {\"absl_hardening_tests\": \"c05b15159f78ec90e1fcf88ea57dd97a6a8f0a28\", \"accessibility_unittests\": \"31cfc0b1f756967ffac660280805ead96706530d\", \"angle_unittests\": \"c5238fbac667f35aac83726edee47472657803a4\", \"app_list_unittests\": \"6d3b252058796dca26903fa5bd7f6f67f2304a90\", \"app_shell_unittests\": \"39ceb739b014566849fbb8a97a935bd79aa14b8d\", \"ash_unittests\": \"12c13860a5dffb6b0a4e77bd6f19e1d5048b44bd\", \"aura_unittests\": \"aae96fa57ae7e63a35f7359b7740b55bf365a06d\", \"base_unittests\": \"85fa02e2d181d20d9940143f181373f814579b1f\", \"base_util_unittests\": \"10d0dcb2c09ae80a2ad9074a17c4b0e38fd5da59\", \"blink_common_unittests\": \"60d63b134363ecc74e2597f14c064b4e42d83187\", \"blink_fuzzer_unittests\": \"1a1660cf8486b39e59209e10064c25fc9b047527\", \"blink_heap_unittests\": \"8038d81fd772c2f01c49dff3be3c18d46a3b6dde\", \"blink_platform_unittests\": \"0d43bcd039478ceee1cd6a2c8fac2d62458e8cd7\", \"blink_unittests\": \"07fde5b97b9c109a3f57ea1e90746c208379634f\", \"boringssl_crypto_tests\": \"e9ba5703feaf52ccadc310b43f3b48b6feb10430\", \"boringssl_ssl_tests\": \"e628295e5a619575e5683cab9a9ccb94193d9738\", \"browser_tests\": \"8585888337f0c8d63f4c7b48e922c46b8f912cfc\", \"capture_unittests\": \"1a83c6ac5138507b7727f09c0dfc8e400d9ee897\", \"cast_unittests\": \"d4e96990bee591619344073cbd6eb12e46b4390a\", \"cc_unittests\": \"5f28324e5e0ba3a56e906f5ff281697f2c0975bb\", \"chrome_app_unittests\": \"de88d1d5471ca2a16cfb05988d3fd1694fe057bd\", \"chromedriver_unittests\": \"4cd1051c47750a1926ca62e9f3c89a14f637e0d5\", \"chromeos_components_unittests\": \"e0f8e0f052ba260ef9263da4a7efacafe34a1e8f\", \"chromeos_unittests\": \"d74b079feea5fca08d983d916278f21e0e4c0c7f\", \"components_browsertests\": \"80c63acc2b8f2be39c7a7d4d646783897c1faf1f\", \"components_unittests\": \"dd07bf4982b86be614e198c145a4d88070ded4de\", \"compositor_unittests\": \"6541b6456d9e32d5352ca92cabcadea4cee93014\", \"content_browsertests\": \"333532086a661596c6eef64ed1f63eea15c3d271\", \"content_unittests\": \"27e431105744953e2de4fe875a18ae4f7a3481c4\", \"crashpad_tests\": \"8da47b4e037d09a27bdf64d94698c28eaa8b2dc9\", \"crypto_unittests\": \"1e0ac9123d361c521fafe8dd551c74fd68a726dd\", \"dbus_unittests\": \"1246de960001723a5882146b07c1630003316ec7\", \"device_unittests\": \"cb040c8754b5b97405172642a8a7d3fab1a7cd55\", \"display_unittests\": \"b1e679cf2a24160d3eddcccae07eaf4b5eca156e\", \"events_unittests\": \"fc5f125b6a3fb72dad688ed78ef6d2785226a6cd\", \"exo_unittests\": \"b2227de88e935d1682b2613eb92eab95402e4e53\", \"extensions_browsertests\": \"1ca8c98111e33f1ce2068d6b8a80b950d4637eb1\", \"extensions_unittests\": \"0ee67cc938b96713c0f20b650db815f3b7bcc3a8\", \"filesystem_service_unittests\": \"f32c265ac84b46762fdb29b5a2f786923d04e876\", \"gcm_unit_tests\": \"64815df735ccbd1a09f9b6bbe711b2350c29e236\", \"gfx_unittests\": \"a3047d5800d4be6c5514b4f97427cdc069d020db\", \"gin_unittests\": \"9232f57043e607aacefb45c35cb0293cc2d1ca54\", \"gl_unittests_ozone\": \"bae6937d11c17680765c71caac443b391c77e50f\", \"google_apis_unittests\": \"c0490d8f39298f457030a85e9cfc1eab9e34f087\", \"gpu_unittests\": \"051f43a9cc9d5b90cf62ac45f31510a0d07ae5fc\", \"gwp_asan_unittests\": \"c01c459caa6c5aab275a408eba2071c3d5dd39e9\", \"interactive_ui_tests\": \"395ce024381a3585653f8e2b412de03b7476e6ae\", \"ipc_tests\": \"b618be01f57871a6ce008739826493e59db865ed\", \"jingle_unittests\": \"301d5a70580149be2c1d0a1ac4c921ea2d32f0cc\", \"keyboard_unittests\": \"e3a14b4e020e8cbefe859eb19b923ea59573a237\", \"latency_unittests\": \"a13c2385d596e4d42cf7062d90f3eab2a0ac5fd5\", \"libjingle_xmpp_unittests\": \"341206a7ccdfa75d682f53a2b05ea53704865c98\", \"liburlpattern_unittests\": \"3e7eda49d5abd2d92348f59f7229f29cad56a6f5\", \"media_blink_unittests\": \"5d096b287635685055641aebb7391d5234ebc821\", \"media_unittests\": \"ca7976ad0b095f5bcc5579785c4e3c5aad295f37\", \"message_center_unittests\": \"807758c1f8e6eb64aefafea1d0be68658291292c\", \"midi_unittests\": \"41aca02e12fe1397a12dfad96cc79798c3270aff\", \"mojo_core_unittests\": \"12454e23a281ab503e0bdf7f44526a65cfec3b95\", \"mojo_unittests\": \"e996ea80f8de625a44984dee9e15df79c19392ff\", \"nacl_helper_nonsfi_unittests\": \"faa7a5ab3e4c000f560b6570d6aa9e0ecf173c4f\", \"nacl_loader_unittests\": \"c9f8b73ee81ae1b31733b793c8f6571d0e192f22\", \"native_theme_unittests\": \"9cd739f6eaa7309ac3d4af2f1d1149e11ce4c32f\", \"net_unittests\": \"aff753283d7fee0fccfd6211de2b8b5f628e4109\", \"ozone_gl_unittests\": \"1ce6e46146b39f7333715c328aea0dac2c8f484d\", \"ozone_unittests\": \"af01edcc54993bccc0dd1685441ec9917db24160\", \"ozone_x11_unittests\": \"84505ad87f7d021ebd34a865e8cff4e6f82edde3\", \"pdf_unittests\": \"28dc07f4bd456c1d62ee7a422627b8b4159f619d\", \"perfetto_unittests\": \"be1aa6f51f711faf68d0f1ab602e1cf520bc019b\", \"ppapi_unittests\": \"7d20dba07dacafc6b0e44ae9beedf7499c6ff448\", \"printing_unittests\": \"2c1c94187594b0aadddcd66e894ab0c612e67f7d\", \"remoting_unittests\": \"73729407a5898de4be7ac754afef93adebd6d9cc\", \"sandbox_linux_unittests\": \"c0a25224d5e92a9c3feabe045295aaf337503683\", \"service_manager_unittests\": \"c5ee4eee7d2ac0daf2894fa91e5d879e91f6eabf\", \"services_unittests\": \"1f7af2b7fe7d0efc9ca34fd3259ceaae4bd0230f\", \"shell_dialogs_unittests\": \"3d9b61869e9d4f40b20f2e81fb8d38c61b87781a\", \"skia_unittests\": \"3628e277ae2d00a40f44756d5ca8b3b86ba4b5dc\", \"snapshot_unittests\": \"4ea7b2a8a06e351fd3ca616d69cd27e2714dd65f\", \"sql_unittests\": \"4f449c712d30274fb9f8b1e6800d597e8c2f14c8\", \"storage_unittests\": \"5c36fef7d12d40f47a555cb9cc38f55792a9476d\", \"sync_integration_tests\": \"70de8e50c4ff19506a8e625c42a9ccc1c8454f0d\", \"traffic_annotation_auditor_unittests\": \"afa2abdb448d180dbb038e13094d5036749eb203\", \"ui_base_unittests\": \"319b41160141cd6517961311eb34717e5588c900\", \"ui_chromeos_unittests\": \"6deabed21c8f261b95f4e5a8fbef32511bb2bc34\", \"ui_touch_selection_unittests\": \"6661430d97e535869f35808e1432d3881bfd346f\", \"unit_tests\": \"e1d2cfecff9f06ae0044b36d6f186f406e3e99a3\", \"url_unittests\": \"160bb80cc3f2b55abca8a4e8f3dc38e825a9a1a4\", \"usage_time_limit_unittests\": \"4cb229cf3b236adccd736856ebf933819af11399\", \"views_unittests\": \"dce1c9c38ee45602cde1eaa6cc2c349de54d63fa\", \"viz_unittests\": \"f90f2d861b2b9cca91f7ac6785b0919c21c36552\", \"wayland_client_perftests\": \"daeee9c75b7b6e71f453c662db2c3bb73567ad7e\", \"wm_unittests\": \"7fbcd79f860c15db6dc9e29116fdc35682a7880f\", \"wtf_unittests\": \"5a568aba38e279ff286d35c21bdcddabfdcfe5be\", \"zlib_unittests\": \"48d3628819ade77b23806d45ff21e757486ec9a3\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_578c225c2c50d5653cce8ddfaab266952737b31d66b6113fbb64cc6f5229aebd_v2\", \"builder_6ce0efae7132fe8ed0fd2e62adc5ba9342c3a2d5840b43c14152c2007d6a5024_v2\", \"builder_8afdcfef4ae6fecf44bdc59bc36ab1bd30dfc75b00b262fd5e6b3421af127659_v2\", \"builder_94fa3119a28f4651cdd4fc5b981a64c69b26c151212072333439362290628993_v2\", \"builder_c6f1473df00e57847ed4ff0f74718f3dfb2a5d42012d3d3fe6b396b4c9a29f62_v2\", \"builder_eb9e31050ddbebce4ba6cbaea9a0445903ee5f3e90bdb319e3517a7851b1b7f7_v2\", \"builder_fac2959e29eeee13eb43de2791ff2fcb7aa7ab15952f0beca21f4615b55fa2a2_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-216-medw\"], \"image\": [\"chrome-xenial-20111600-a937a23cefb\"], \"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\": [\"5640-d0eb544\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1606463820232574",
"status": "COMPLETED",
"status_changed_ts": "1606466863388759",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/43231",
"builder:linux-chromeos-rel",
"buildset:commit/git/32d461a269235bc172c5e59a2526272c4ff04a49",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/32d461a269235bc172c5e59a2526272c4ff04a49",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9027924372926320384",
"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/8862494310770637152/+/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:502186165c757210",
"user_agent:luci-scheduler"
],
"updated_ts": "1606466863401587",
"url": "https://ci.chromium.org/b/8862494310770637152",
"utcnow_ts": "1606466864717108"
}
}
[08:47:44.731] Invocation finished in 50m47.44046054s with status SUCCEEDED