[08:32:31.571] New invocation is queued and will start shortly
[08:32:36.172] Starting the invocation (attempt 1)
[08:32:36.207] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[08:32:36.208] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[08:32:36.208] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9027559747121539168",
"parameters_json": "{\"builder_name\":\"linux-chromeos-rel\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"53f1bcefea6aa719908ad8fecebcada75b67c2ba\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-rel",
"scheduler_invocation_id:9027559747121539168",
"scheduler_job_id:chromium/linux-chromeos-rel",
"user_agent:luci-scheduler",
"buildset:commit/git/53f1bcefea6aa719908ad8fecebcada75b67c2ba",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/53f1bcefea6aa719908ad8fecebcada75b67c2ba",
"gitiles_ref:refs/heads/master"
]
}
[08:32:36.767] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1606811556291809",
"id": "8862129681508606944",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"53f1bcefea6aa719908ad8fecebcada75b67c2ba\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1606811556634291",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/43334",
"builder:linux-chromeos-rel",
"buildset:commit/git/53f1bcefea6aa719908ad8fecebcada75b67c2ba",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/53f1bcefea6aa719908ad8fecebcada75b67c2ba",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9027559747121539168",
"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/8862129681508606944/+/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": "1606811556634402",
"url": "https://ci.chromium.org/b/8862129681508606944",
"utcnow_ts": "1606811556755333"
}
}
[08:32:36.767] Task URL: https://ci.chromium.org/b/8862129681508606944
[08:32:36.767] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:2:0) after 1m0s
[08:33:33.778] Received PubSub notification, asking Buildbucket for the build status
[08:33:33.858] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:33:36.961] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:2:0)
[08:33:36.961] Timer tick, asking Buildbucket for the build status
[08:33:37.032] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:33:37.032] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:4:0) after 1m0s
[08:34:37.050] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:4:0)
[08:34:37.050] Timer tick, asking Buildbucket for the build status
[08:34:37.435] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:34:37.435] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:5:0) after 1m0s
[08:35:37.458] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:5:0)
[08:35:37.458] Timer tick, asking Buildbucket for the build status
[08:35:37.592] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:35:37.592] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:6:0) after 1m0s
[08:36:37.648] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:6:0)
[08:36:37.648] Timer tick, asking Buildbucket for the build status
[08:36:37.776] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:36:37.776] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:7:0) after 1m0s
[08:37:37.828] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:7:0)
[08:37:37.828] Timer tick, asking Buildbucket for the build status
[08:37:37.944] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:37:37.944] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:8:0) after 1m0s
[08:38:38.036] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:8:0)
[08:38:38.036] Timer tick, asking Buildbucket for the build status
[08:38:38.327] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:38:38.327] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:9:0) after 1m0s
[08:39:38.420] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:9:0)
[08:39:38.420] Timer tick, asking Buildbucket for the build status
[08:39:38.599] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:39:38.599] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:10:0) after 1m0s
[08:40:38.672] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:10:0)
[08:40:38.672] Timer tick, asking Buildbucket for the build status
[08:40:38.808] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:40:38.808] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:11:0) after 1m0s
[08:41:38.852] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:11:0)
[08:41:38.852] Timer tick, asking Buildbucket for the build status
[08:41:39.154] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:41:39.154] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:12:0) after 1m0s
[08:42:39.163] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:12:0)
[08:42:39.163] Timer tick, asking Buildbucket for the build status
[08:42:39.257] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:42:39.257] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:13:0) after 1m0s
[08:43:39.242] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:13:0)
[08:43:39.242] Timer tick, asking Buildbucket for the build status
[08:43:39.345] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:43:39.345] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:14:0) after 1m0s
[08:44:39.436] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:14:0)
[08:44:39.436] Timer tick, asking Buildbucket for the build status
[08:44:39.663] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:44:39.663] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:15:0) after 1m0s
[08:45:39.824] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:15:0)
[08:45:39.824] Timer tick, asking Buildbucket for the build status
[08:45:39.896] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:45:39.896] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:16:0) after 1m0s
[08:46:39.918] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:16:0)
[08:46:39.918] Timer tick, asking Buildbucket for the build status
[08:46:40.140] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:46:40.140] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:17:0) after 1m0s
[08:47:40.158] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:17:0)
[08:47:40.158] Timer tick, asking Buildbucket for the build status
[08:47:40.472] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:47:40.472] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:18:0) after 1m0s
[08:48:40.573] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:18:0)
[08:48:40.573] Timer tick, asking Buildbucket for the build status
[08:48:40.670] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:48:40.670] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:19:0) after 1m0s
[08:49:40.673] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:19:0)
[08:49:40.673] Timer tick, asking Buildbucket for the build status
[08:49:40.927] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:49:40.927] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:20:0) after 1m0s
[08:50:40.946] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:20:0)
[08:50:40.946] Timer tick, asking Buildbucket for the build status
[08:50:41.106] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:50:41.106] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:21:0) after 1m0s
[08:51:41.091] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:21:0)
[08:51:41.091] Timer tick, asking Buildbucket for the build status
[08:51:41.171] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:51:41.171] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:22:0) after 1m0s
[08:52:41.235] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:22:0)
[08:52:41.235] Timer tick, asking Buildbucket for the build status
[08:52:41.365] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:52:41.365] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:23:0) after 1m0s
[08:53:41.427] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:23:0)
[08:53:41.427] Timer tick, asking Buildbucket for the build status
[08:53:41.657] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:53:41.657] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:24:0) after 1m0s
[08:54:41.677] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:24:0)
[08:54:41.677] Timer tick, asking Buildbucket for the build status
[08:54:41.739] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:54:41.739] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:25:0) after 1m0s
[08:55:41.755] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:25:0)
[08:55:41.755] Timer tick, asking Buildbucket for the build status
[08:55:42.531] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:55:42.531] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:26:0) after 1m0s
[08:56:43.516] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:26:0)
[08:56:43.516] Timer tick, asking Buildbucket for the build status
[08:56:44.235] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:56:44.235] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:27:0) after 1m0s
[08:57:44.538] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:27:0)
[08:57:44.538] Timer tick, asking Buildbucket for the build status
[08:57:44.640] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:57:44.640] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:28:0) after 1m0s
[08:58:44.745] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:28:0)
[08:58:44.745] Timer tick, asking Buildbucket for the build status
[08:58:44.811] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:58:44.811] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:29:0) after 1m0s
[08:59:45.027] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:29:0)
[08:59:45.027] Timer tick, asking Buildbucket for the build status
[08:59:45.086] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:59:45.086] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:30:0) after 1m0s
[09:00:45.204] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:30:0)
[09:00:45.204] Timer tick, asking Buildbucket for the build status
[09:00:45.300] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:00:45.300] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:31:0) after 1m0s
[09:01:45.930] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:31:0)
[09:01:45.930] Timer tick, asking Buildbucket for the build status
[09:01:46.107] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:01:46.107] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:32:0) after 1m0s
[09:02:46.154] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:32:0)
[09:02:46.154] Timer tick, asking Buildbucket for the build status
[09:02:46.252] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:02:46.252] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:33:0) after 1m0s
[09:03:46.276] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:33:0)
[09:03:46.276] Timer tick, asking Buildbucket for the build status
[09:03:46.344] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:03:46.344] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:34:0) after 1m0s
[09:04:46.393] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:34:0)
[09:04:46.393] Timer tick, asking Buildbucket for the build status
[09:04:46.470] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:04:46.470] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:35:0) after 1m0s
[09:05:46.571] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:35:0)
[09:05:46.571] Timer tick, asking Buildbucket for the build status
[09:05:46.629] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:05:46.629] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:36:0) after 1m0s
[09:06:46.668] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:36:0)
[09:06:46.668] Timer tick, asking Buildbucket for the build status
[09:06:46.726] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:06:46.726] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:37:0) after 1m0s
[09:07:46.812] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:37:0)
[09:07:46.812] Timer tick, asking Buildbucket for the build status
[09:07:46.991] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:07:46.991] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:38:0) after 1m0s
[09:08:47.055] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:38:0)
[09:08:47.055] Timer tick, asking Buildbucket for the build status
[09:08:47.150] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:08:47.150] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:39:0) after 1m0s
[09:09:47.152] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:39:0)
[09:09:47.152] Timer tick, asking Buildbucket for the build status
[09:09:47.231] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:09:47.231] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:40:0) after 1m0s
[09:10:47.245] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:40:0)
[09:10:47.245] Timer tick, asking Buildbucket for the build status
[09:10:47.381] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:10:47.381] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:41:0) after 1m0s
[09:11:47.380] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:41:0)
[09:11:47.380] Timer tick, asking Buildbucket for the build status
[09:11:47.469] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:11:47.469] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:42:0) after 1m0s
[09:12:47.527] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:42:0)
[09:12:47.527] Timer tick, asking Buildbucket for the build status
[09:12:47.694] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:12:47.694] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:43:0) after 1m0s
[09:13:47.722] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:43:0)
[09:13:47.722] Timer tick, asking Buildbucket for the build status
[09:13:47.807] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:13:47.807] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:44:0) after 1m0s
[09:14:48.174] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:44:0)
[09:14:48.174] Timer tick, asking Buildbucket for the build status
[09:14:48.275] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:14:48.275] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:45:0) after 1m0s
[09:15:48.278] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:45:0)
[09:15:48.278] Timer tick, asking Buildbucket for the build status
[09:15:48.363] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:15:48.363] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:46:0) after 1m0s
[09:16:48.764] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:46:0)
[09:16:48.764] Timer tick, asking Buildbucket for the build status
[09:16:48.892] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:16:48.892] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:47:0) after 1m0s
[09:17:49.122] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:47:0)
[09:17:49.122] Timer tick, asking Buildbucket for the build status
[09:17:49.217] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:17:49.217] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:48:0) after 1m0s
[09:18:49.312] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:48:0)
[09:18:49.312] Timer tick, asking Buildbucket for the build status
[09:18:49.465] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:18:49.465] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:49:0) after 1m0s
[09:19:49.747] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:49:0)
[09:19:49.747] Timer tick, asking Buildbucket for the build status
[09:19:49.852] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:19:49.852] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:50:0) after 1m0s
[09:20:50.025] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:50:0)
[09:20:50.025] Timer tick, asking Buildbucket for the build status
[09:20:50.333] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:20:50.333] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:51:0) after 1m0s
[09:21:50.912] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:51:0)
[09:21:50.912] Timer tick, asking Buildbucket for the build status
[09:21:51.131] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:21:51.131] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:52:0) after 1m0s
[09:22:51.172] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:52:0)
[09:22:51.172] Timer tick, asking Buildbucket for the build status
[09:22:51.436] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:22:51.436] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:53:0) after 1m0s
[09:23:51.485] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:53:0)
[09:23:51.485] Timer tick, asking Buildbucket for the build status
[09:23:51.891] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:23:51.891] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:54:0) after 1m0s
[09:24:51.960] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:54:0)
[09:24:51.960] Timer tick, asking Buildbucket for the build status
[09:24:52.083] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:24:52.083] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:55:0) after 1m0s
[09:25:52.167] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:55:0)
[09:25:52.167] Timer tick, asking Buildbucket for the build status
[09:25:52.274] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:25:52.274] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:56:0) after 1m0s
[09:26:52.412] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:56:0)
[09:26:52.412] Timer tick, asking Buildbucket for the build status
[09:26:52.606] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:26:52.606] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:57:0) after 1m0s
[09:27:52.705] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:57:0)
[09:27:52.705] Timer tick, asking Buildbucket for the build status
[09:27:53.761] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:27:53.761] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:58:0) after 1m0s
[09:28:53.865] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:58:0)
[09:28:53.865] Timer tick, asking Buildbucket for the build status
[09:28:53.989] Build 8862129681508606944: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:28:53.989] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9027559747121539168:59:0) after 1m0s
[09:29:43.190] Received PubSub notification, asking Buildbucket for the build status
[09:29:43.293] Build 8862129681508606944: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[09:29:43.293] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1606814981033405",
"created_by": "project:chromium",
"created_ts": "1606811556291809",
"failure_reason": "BUILD_FAILURE",
"id": "8862129681508606944",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"53f1bcefea6aa719908ad8fecebcada75b67c2ba\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed because of:\\n\\n- SystemWebAppManagerMultiDesktopLaunchBrowserTest.LaunchToActiveDesktop\"}, \"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\": \"53f1bcefea6aa719908ad8fecebcada75b67c2ba\", \"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-200-9pyh\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-rel\", \"buildnumber\": 43334, \"got_angle_revision\": \"ccd0b7e15e47bb07cf393d725d2b987672ccfb24\", \"got_dawn_revision\": \"a827aa2c29aa41346e95e6ac58a752709beb5977\", \"got_nacl_revision\": \"3ac0b060c794b64531b47dfded8ff8d951a5c648\", \"got_revision\": \"53f1bcefea6aa719908ad8fecebcada75b67c2ba\", \"got_revision_cp\": \"refs/heads/master@{#832251}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"1eadcfb3be99c2eca944774a78c4e3c16132958b\", \"got_v8_revision\": \"f1e2bbd80f2e2eacf7e043e18ee55f0b8cf22171\", \"got_v8_revision_cp\": \"refs/heads/8.9.71@{#1}\", \"got_webrtc_revision\": \"bcca3b08a90fccaa6dd8d86f6079f0ca0553ab4a\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32715}\", \"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\": \"53f1bcefea6aa719908ad8fecebcada75b67c2ba\", \"swarm_hashes_refs/heads/master(at){#832251}_without_patch\": {\"absl_hardening_tests\": \"42f855e5117850c4083b4a27568a980c70d4fefa\", \"accessibility_unittests\": \"ea7ab1f4d7669ab2ac38c80541183d9711199623\", \"angle_unittests\": \"0789a145c31888f2a026a51b0f1e69bebce6a950\", \"app_list_unittests\": \"b29fc5fe41d36762bfe85e9392e8dd63b9ba49cf\", \"app_shell_unittests\": \"19353973ed6ddb6355426dc5b564733a8ae76d27\", \"ash_unittests\": \"a0b428020d95bd1bb9797c0e9d65b91460327f82\", \"aura_unittests\": \"8ad9f385af58ca77c1ce8ad19f0660c3161c927c\", \"base_unittests\": \"7ce7d968185cbea93953466ea1a8116b3eef8c79\", \"base_util_unittests\": \"43707bacf8f735edca8ae478f63062ca3278e7a2\", \"blink_common_unittests\": \"5d212a08108dbba476826ecd64c77f9655b4421c\", \"blink_fuzzer_unittests\": \"2c6469d61cf16e1dbe5ac809c3c25559d72b2eb8\", \"blink_heap_unittests\": \"60d506da98a6ebc50d847e32157104bd94991c4e\", \"blink_platform_unittests\": \"857c7257333388dd0313d152b44f131de4d1f632\", \"blink_unittests\": \"711f146cfb60f132be39ae40869934c425a1b309\", \"boringssl_crypto_tests\": \"f5294bf1f50ca96b06d14ee8baf34efc8cb767e7\", \"boringssl_ssl_tests\": \"d4ed35a23af4946f4dffa3f478946f656bebe508\", \"browser_tests\": \"bc41b93bdc19e44847b0e0079f58f07809d93b2a\", \"capture_unittests\": \"a91a9de785136fc3a59a167fdac9c28059700fa1\", \"cast_unittests\": \"5da32de26562b350dffa82a2c53999b68505b735\", \"cc_unittests\": \"2d8434d3dc73600343d21a6aeda081ca93944869\", \"chrome_app_unittests\": \"50f35c59898073787abf275b2c02ef78b3d75cc8\", \"chromedriver_unittests\": \"dcf1cabdbe912cd418a12365ef0cc2b992c1ca69\", \"chromeos_components_unittests\": \"ced0e0c5cfe8e228d58939be3e94d01c1f310c12\", \"chromeos_unittests\": \"294623c2b5057ab0107c479239b5d45e70a54dc0\", \"components_browsertests\": \"432ea803b695b6e1a1338ebc193177d640cdd481\", \"components_unittests\": \"1bb980d44edb838018e9e9acd2dff24f0ae6da8b\", \"compositor_unittests\": \"8eab93fd4d95f34f32d950c840a9122a53a102e2\", \"content_browsertests\": \"55925c7a8229d5db19108d896e90c5e1b1168add\", \"content_unittests\": \"9ccb34b85c6c2f1ef66fb14ec286c0103687e2cb\", \"crashpad_tests\": \"2c3c96ac250d0a78be64c4241d6ec4620b0588fc\", \"crypto_unittests\": \"0d0a6925264db776fa92f92043ad5b6bb2a7f266\", \"dbus_unittests\": \"c4fc02eed74803084fc4b3a6be61d05deed6e9ce\", \"device_unittests\": \"9f6de09fedc7f757ed467cff0233e586f9ce2a8c\", \"display_unittests\": \"239e83be726274f60f09f9e7dbf1789cefd21eff\", \"events_unittests\": \"1819d613b5363a0ea4d0abb657a9db981e944f53\", \"exo_unittests\": \"bf085db3c2246d335f7af273d14760e649fe5bd4\", \"extensions_browsertests\": \"4fd04952c3bc2222051e883dae610f4a62ffb26e\", \"extensions_unittests\": \"812cf3c063df5ed7bb3de48cfd7c1cb18de90c70\", \"filesystem_service_unittests\": \"35aeff1ab34b5e8730d116843598f7c0e60e7c0d\", \"gcm_unit_tests\": \"2657ae0573246b08ecb71801f71e81afa22e36f9\", \"gfx_unittests\": \"13d0ca4391001a3512d78c6b3c3f2f9ab2b42036\", \"gin_unittests\": \"40a1f8bf3e2eb1619a9989ab96c893b4d3d66585\", \"gl_unittests_ozone\": \"32e6311182f0e5853853495cf0d5adcd5a5af0cc\", \"google_apis_unittests\": \"ad22fc4cccb5ff6871cbfe59fe3fa93dd36ff505\", \"gpu_unittests\": \"623d481244aadb0089364458cd06a64eed1332e1\", \"gwp_asan_unittests\": \"e521d7235096937a8ea95bdd5cbc46406ad13c88\", \"interactive_ui_tests\": \"5632ff5e13064e33ee46b8449afb7a551c24fdc2\", \"ipc_tests\": \"100f769148f12912fcc4fa25d65221b96639106f\", \"jingle_unittests\": \"c4b949cbad500375a5e15adf6e598efcda976242\", \"keyboard_unittests\": \"202687aa14b6d4234fab53149e6534b6325a2e8d\", \"latency_unittests\": \"a8e2439d1af03748a5f13b1a4bb5a30d62f6d9c3\", \"libjingle_xmpp_unittests\": \"774116d00476b727af3270704fe82ff154edb9e3\", \"liburlpattern_unittests\": \"a4b31b30c065e3fcaf5c2007d485f4df63b74b9a\", \"media_blink_unittests\": \"48e08c0fcb0a9066fd58dcb26cedb25c62b3304d\", \"media_unittests\": \"5ed5f6f068fabde13d3e8b9058d741ca316c74ca\", \"message_center_unittests\": \"a991087a9308f60e306f6def43022c7e3dd7553e\", \"midi_unittests\": \"e77a85cc03e081461b9a3f00de5bf3d25a3af9fe\", \"mojo_core_unittests\": \"7592bf35411c9686bf514d37ec87ed8f6f28efa5\", \"mojo_unittests\": \"6724612cc354c9e0086f140680dbb71e9b095624\", \"nacl_helper_nonsfi_unittests\": \"382826e1cab9a008f3b39d8f2bc06e593337f9e3\", \"nacl_loader_unittests\": \"d3f9fe4f4900e2e7e0e0ba939e93b62aaa91dc2e\", \"native_theme_unittests\": \"7460f2b1ad1d99a558ec0e9b83d2c66376a04b32\", \"net_unittests\": \"e4c9af451068b629edef5a3dcd8aa26c3e8cf16c\", \"ozone_gl_unittests\": \"442e08e5cfc3b45ad48098fc6f359cd37674f2ce\", \"ozone_unittests\": \"fcfbc7dbb82fb0db5d1ac1a2855058cc0c0c4e2b\", \"ozone_x11_unittests\": \"274ff5df053eeae6f709572b6bb6e1d56dbb4900\", \"pdf_unittests\": \"8b863a987c419dc60fcd725236dba351acdbd027\", \"perfetto_unittests\": \"8e3dbcb599fadc65e26f98a364cf34994d92f931\", \"ppapi_unittests\": \"571ca7d32f0d446fad7df3b41b220038ad36ddf5\", \"printing_unittests\": \"a758e6949ff23d26f89aabe9b6e059953dadc077\", \"remoting_unittests\": \"af01ac5e091f16d959886e407f3abf2281fb1f02\", \"sandbox_linux_unittests\": \"8a07fffefe7bea9ab8f38a225f6705ad9f5dd773\", \"service_manager_unittests\": \"67ad2d69478afe3f29ca881d818a8e93dcad180b\", \"services_unittests\": \"fe46d70c87489dd4a359899b0cdd8816ce05b0b9\", \"shell_dialogs_unittests\": \"7ba3260e9558ffc901636958d534fb7540b395a6\", \"skia_unittests\": \"0a5f12c30ea08b1e9804c1fc658370aba2cbe60e\", \"snapshot_unittests\": \"e278499313126dd3fd1ff788eb3d68e03f0a1681\", \"sql_unittests\": \"1fc6570e1e92f8917bf8cd7af560cc52d989e88d\", \"storage_unittests\": \"80d07825dfa96a7485ac27abb4a3a840c724a603\", \"sync_integration_tests\": \"2c7926d1e642f5666d6133f5d836eee65396d442\", \"traffic_annotation_auditor_unittests\": \"9a9973d05b7566e289d59459e73f0d478f215f6f\", \"ui_base_unittests\": \"014b74e145e26e432dda3777fec6d73e36587a77\", \"ui_chromeos_unittests\": \"1148c6246ad2b2ccd065102f64169dbc79c579c1\", \"ui_touch_selection_unittests\": \"aca572ecdc1163e9c9d0fa7ffd568d7443eef38a\", \"unit_tests\": \"6f9076f29c3c8ef3d17a2678d73e4065528f3918\", \"url_unittests\": \"eaa03495e60814214dc271dfa5a9aef9c2e0053d\", \"usage_time_limit_unittests\": \"55e5e79e79ef66a0e1f6c4af6d9e10e613dc7b39\", \"views_unittests\": \"37080bc9e9806f39a0701479db2a127e8821385d\", \"viz_unittests\": \"45f5124cbeed54488e2544c402657b62371cf5a0\", \"wayland_client_perftests\": \"b1b05349fa11b9c4c897145b2341518b4255579e\", \"wm_unittests\": \"3f455a24eff7764f82c693b7f91ac2682146ea73\", \"wtf_unittests\": \"51d96ddc44750df8b778d8413a216e05f8e36a0f\", \"zlib_unittests\": \"d2a7bbefb983fed362999e7b15739137d529f808\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_0e22c04085d4f23fdc95f18e428a3d660f7cf1c501a8c991d94e3298ba2ece61_v2\", \"builder_1cac3a12be5110575bfda3df59662d0c101b80b5d04053a56e3716a56e114d29_v2\", \"builder_71571186c069bf1b966218e7a22ae0e5b91b31e38e06bc6997883c49bda8b59a_v2\", \"builder_94fa3119a28f4651cdd4fc5b981a64c69b26c151212072333439362290628993_v2\", \"builder_a7b9f8880f1f76f2cce14c79e9b35da9a713af6654c6d1393cfbcc356d1ede5d_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-200-9pyh\"], \"image\": [\"chrome-xenial-20112200-f7cdea8df03\"], \"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\"]}}, \"ui\": {\"info\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed because of:\\n\\n- SystemWebAppManagerMultiDesktopLaunchBrowserTest.LaunchToActiveDesktop\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1606811612111173",
"status": "COMPLETED",
"status_changed_ts": "1606811612428551",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/43334",
"builder:linux-chromeos-rel",
"buildset:commit/git/53f1bcefea6aa719908ad8fecebcada75b67c2ba",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/53f1bcefea6aa719908ad8fecebcada75b67c2ba",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9027559747121539168",
"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/8862129681508606944/+/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:503640259467a110",
"user_agent:luci-scheduler"
],
"updated_ts": "1606814982652579",
"url": "https://ci.chromium.org/b/8862129681508606944",
"utcnow_ts": "1606814983281955"
}
}
[09:29:43.294] Invocation finished in 57m11.73913382s with status FAILED