[10:58:13.252] New invocation is queued and will start shortly
[10:58:14.361] Starting the invocation (attempt 1)
[10:58:14.411] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[10:58:14.412] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[10:58:14.412] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9022386553721228064",
"parameters_json": "{\"builder_name\":\"linux-chromeos-rel\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"68470500ede1f454438f41e38ee13c555056ed1e\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-rel",
"scheduler_invocation_id:9022386553721228064",
"scheduler_job_id:chromium/linux-chromeos-rel",
"user_agent:luci-scheduler",
"buildset:commit/git/68470500ede1f454438f41e38ee13c555056ed1e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/68470500ede1f454438f41e38ee13c555056ed1e",
"gitiles_ref:refs/heads/master"
]
}
[10:58:16.867] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1611745094640540",
"id": "8856956491601149296",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"68470500ede1f454438f41e38ee13c555056ed1e\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1611745096403925",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/44942",
"builder:linux-chromeos-rel",
"buildset:commit/git/68470500ede1f454438f41e38ee13c555056ed1e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/68470500ede1f454438f41e38ee13c555056ed1e",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9022386553721228064",
"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/8856956491601149296/+/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": "1611745096404168",
"url": "https://ci.chromium.org/b/8856956491601149296",
"utcnow_ts": "1611745096847931"
}
}
[10:58:16.867] Task URL: https://ci.chromium.org/b/8856956491601149296
[10:58:16.867] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:2:0) after 1m0s
[10:58:58.773] Received PubSub notification, asking Buildbucket for the build status
[10:58:59.074] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:59:17.024] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:2:0)
[10:59:17.024] Timer tick, asking Buildbucket for the build status
[10:59:17.123] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:59:17.123] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:4:0) after 1m0s
[11:00:17.181] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:4:0)
[11:00:17.181] Timer tick, asking Buildbucket for the build status
[11:00:17.788] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:00:17.788] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:5:0) after 1m0s
[11:01:17.898] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:5:0)
[11:01:17.898] Timer tick, asking Buildbucket for the build status
[11:01:18.163] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:01:18.163] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:6:0) after 1m0s
[11:02:18.298] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:6:0)
[11:02:18.298] Timer tick, asking Buildbucket for the build status
[11:02:18.642] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:02:18.642] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:7:0) after 1m0s
[11:03:18.735] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:7:0)
[11:03:18.735] Timer tick, asking Buildbucket for the build status
[11:03:18.808] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:03:18.808] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:8:0) after 1m0s
[11:04:18.838] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:8:0)
[11:04:18.838] Timer tick, asking Buildbucket for the build status
[11:04:19.051] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:04:19.051] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:9:0) after 1m0s
[11:05:19.137] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:9:0)
[11:05:19.137] Timer tick, asking Buildbucket for the build status
[11:05:19.228] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:05:19.228] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:10:0) after 1m0s
[11:06:19.256] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:10:0)
[11:06:19.256] Timer tick, asking Buildbucket for the build status
[11:06:19.418] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:06:19.418] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:11:0) after 1m0s
[11:07:19.517] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:11:0)
[11:07:19.517] Timer tick, asking Buildbucket for the build status
[11:07:19.934] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:07:19.934] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:12:0) after 1m0s
[11:08:19.931] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:12:0)
[11:08:19.931] Timer tick, asking Buildbucket for the build status
[11:08:21.335] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:08:21.335] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:13:0) after 1m0s
[11:09:21.371] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:13:0)
[11:09:21.371] Timer tick, asking Buildbucket for the build status
[11:09:21.447] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:09:21.447] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:14:0) after 1m0s
[11:10:21.483] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:14:0)
[11:10:21.483] Timer tick, asking Buildbucket for the build status
[11:10:21.684] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:10:21.684] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:15:0) after 1m0s
[11:11:21.721] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:15:0)
[11:11:21.721] Timer tick, asking Buildbucket for the build status
[11:11:21.775] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:11:21.775] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:16:0) after 1m0s
[11:12:21.780] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:16:0)
[11:12:21.780] Timer tick, asking Buildbucket for the build status
[11:12:21.869] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:12:21.869] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:17:0) after 1m0s
[11:13:21.927] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:17:0)
[11:13:21.927] Timer tick, asking Buildbucket for the build status
[11:13:22.202] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:13:22.202] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:18:0) after 1m0s
[11:14:22.222] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:18:0)
[11:14:22.222] Timer tick, asking Buildbucket for the build status
[11:14:22.763] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:14:22.763] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:19:0) after 1m0s
[11:15:22.786] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:19:0)
[11:15:22.786] Timer tick, asking Buildbucket for the build status
[11:15:23.575] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:15:23.575] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:20:0) after 1m0s
[11:16:23.654] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:20:0)
[11:16:23.654] Timer tick, asking Buildbucket for the build status
[11:16:24.144] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:16:24.144] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:21:0) after 1m0s
[11:17:24.441] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:21:0)
[11:17:24.441] Timer tick, asking Buildbucket for the build status
[11:17:24.644] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:17:24.644] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:22:0) after 1m0s
[11:18:24.626] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:22:0)
[11:18:24.626] Timer tick, asking Buildbucket for the build status
[11:18:24.810] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:18:24.810] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:23:0) after 1m0s
[11:19:24.860] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:23:0)
[11:19:24.860] Timer tick, asking Buildbucket for the build status
[11:19:24.944] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:19:24.944] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:24:0) after 1m0s
[11:20:25.145] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:24:0)
[11:20:25.145] Timer tick, asking Buildbucket for the build status
[11:20:25.228] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:20:25.228] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:25:0) after 1m0s
[11:21:25.243] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:25:0)
[11:21:25.243] Timer tick, asking Buildbucket for the build status
[11:21:25.376] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:21:25.376] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:26:0) after 1m0s
[11:22:25.517] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:26:0)
[11:22:25.517] Timer tick, asking Buildbucket for the build status
[11:22:25.607] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:22:25.607] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:27:0) after 1m0s
[11:23:25.718] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:27:0)
[11:23:25.718] Timer tick, asking Buildbucket for the build status
[11:23:26.166] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:23:26.166] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:28:0) after 1m0s
[11:24:26.245] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:28:0)
[11:24:26.245] Timer tick, asking Buildbucket for the build status
[11:24:26.393] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:24:26.393] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:29:0) after 1m0s
[11:25:26.437] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:29:0)
[11:25:26.437] Timer tick, asking Buildbucket for the build status
[11:25:26.549] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:25:26.550] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:30:0) after 1m0s
[11:26:26.650] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:30:0)
[11:26:26.650] Timer tick, asking Buildbucket for the build status
[11:26:26.810] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:26:26.810] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:31:0) after 1m0s
[11:27:26.866] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:31:0)
[11:27:26.866] Timer tick, asking Buildbucket for the build status
[11:27:26.990] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:27:26.990] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:32:0) after 1m0s
[11:28:27.082] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:32:0)
[11:28:27.082] Timer tick, asking Buildbucket for the build status
[11:28:27.285] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:28:27.285] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:33:0) after 1m0s
[11:29:27.353] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:33:0)
[11:29:27.353] Timer tick, asking Buildbucket for the build status
[11:29:27.480] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:29:27.480] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:34:0) after 1m0s
[11:30:27.546] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:34:0)
[11:30:27.546] Timer tick, asking Buildbucket for the build status
[11:30:28.106] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:30:28.106] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:35:0) after 1m0s
[11:31:28.172] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:35:0)
[11:31:28.172] Timer tick, asking Buildbucket for the build status
[11:31:28.579] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:31:28.579] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:36:0) after 1m0s
[11:32:28.591] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:36:0)
[11:32:28.591] Timer tick, asking Buildbucket for the build status
[11:32:29.380] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:32:29.380] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:37:0) after 1m0s
[11:33:29.413] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:37:0)
[11:33:29.413] Timer tick, asking Buildbucket for the build status
[11:33:29.513] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:33:29.513] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:38:0) after 1m0s
[11:34:29.674] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:38:0)
[11:34:29.674] Timer tick, asking Buildbucket for the build status
[11:34:29.841] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:34:29.841] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:39:0) after 1m0s
[11:35:29.991] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:39:0)
[11:35:29.991] Timer tick, asking Buildbucket for the build status
[11:35:30.166] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:35:30.166] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:40:0) after 1m0s
[11:36:30.269] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:40:0)
[11:36:30.269] Timer tick, asking Buildbucket for the build status
[11:36:30.370] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:36:30.370] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:41:0) after 1m0s
[11:37:30.422] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:41:0)
[11:37:30.422] Timer tick, asking Buildbucket for the build status
[11:37:30.815] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:37:30.815] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:42:0) after 1m0s
[11:38:30.894] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:42:0)
[11:38:30.894] Timer tick, asking Buildbucket for the build status
[11:38:31.021] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:38:31.021] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:43:0) after 1m0s
[11:39:31.124] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:43:0)
[11:39:31.124] Timer tick, asking Buildbucket for the build status
[11:39:31.359] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:39:31.359] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:44:0) after 1m0s
[11:40:31.455] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:44:0)
[11:40:31.455] Timer tick, asking Buildbucket for the build status
[11:40:31.594] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:40:31.594] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:45:0) after 1m0s
[11:41:31.691] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:45:0)
[11:41:31.691] Timer tick, asking Buildbucket for the build status
[11:41:31.833] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:41:31.833] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:46:0) after 1m0s
[11:42:31.847] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:46:0)
[11:42:31.847] Timer tick, asking Buildbucket for the build status
[11:42:32.267] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:42:32.267] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:47:0) after 1m0s
[11:43:32.356] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:47:0)
[11:43:32.356] Timer tick, asking Buildbucket for the build status
[11:43:32.636] Build 8856956491601149296: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:43:32.636] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9022386553721228064:48:0) after 1m0s
[11:44:12.818] Received PubSub notification, asking Buildbucket for the build status
[11:44:12.929] Build 8856956491601149296: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[11:44:12.934] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1611747851775103",
"created_by": "project:chromium",
"created_ts": "1611745094640540",
"failure_reason": "BUILD_FAILURE",
"id": "8856956491601149296",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"68470500ede1f454438f41e38ee13c555056ed1e\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed because of:\\n\\n- HoldingSpace/FilesAppBrowserTest.Test/holdingSpaceWelcomeBannerWithFeatureEnabled\"}, \"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\": \"68470500ede1f454438f41e38ee13c555056ed1e\", \"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-23-q58c\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-rel\", \"buildnumber\": 44942, \"got_angle_revision\": \"c38413f86cb98f088043c05eac900e7a9986d52a\", \"got_dawn_revision\": \"2df77f4325841e667e6b9ff9921fd626496a3b64\", \"got_nacl_revision\": \"cb31feffa500401c95c6c44d88b7c358236bca36\", \"got_revision\": \"68470500ede1f454438f41e38ee13c555056ed1e\", \"got_revision_cp\": \"refs/heads/master@{#847571}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"aec0826aba0db51914209ec85a515d3a99311f07\", \"got_v8_revision\": \"ca438ce0794e4f833cc87f59232139df05f0ae73\", \"got_v8_revision_cp\": \"refs/heads/9.0.84@{#1}\", \"got_webrtc_revision\": \"fae4fb13451bea44ae1a94509befe8d7c6b11eb6\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33077}\", \"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\", \"prev_got_revision\": \"1996f74b30b833784236f05faaafe725f529d530\", \"prev_got_revision_cp\": \"refs/heads/master@{#847551}\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"68470500ede1f454438f41e38ee13c555056ed1e\", \"swarm_hashes_refs/heads/master(at){#847571}_without_patch\": {\"absl_hardening_tests\": \"ba47532e0184d1ec1795c03e4eb4806e08803548\", \"accessibility_unittests\": \"2174c8327917218b189c80611b33e0cf33f2d765\", \"angle_unittests\": \"d43f198b434a3a655043ddab6c9c8a31a224f5db\", \"app_list_unittests\": \"e6f97479114e098b86359132e43e4f236b51dfec\", \"app_shell_unittests\": \"4ead3f9a8d0d2be2df7b3263a288df365b6b8a9a\", \"ash_unittests\": \"003054d1508a7cd99ddfe7ef5dc4b41672eca0af\", \"aura_unittests\": \"8ab7e42b5cc2056da5e6e35f15a0d027a20f4f2e\", \"base_unittests\": \"2d5c7fbb6ee462dd48a2e0ec139dc906b34d0184\", \"base_util_unittests\": \"8dcf5e343fe8f402d60d1c592e2eb15ab487b443\", \"blink_common_unittests\": \"05dc83145bcfe316ce35171c18ace79ec43b91e2\", \"blink_fuzzer_unittests\": \"df9c00ece0168c77a6d606ed3f279655c3fa0325\", \"blink_heap_unittests\": \"4468400aa5f3d92666b5dbdd256a8f02dce3c2b5\", \"blink_platform_unittests\": \"10bfe7c6e52cb1e88655660eeb0c08ed376a8151\", \"blink_unittests\": \"d552726b25fefe905fd4d6772e27f4ad4c7c4012\", \"boringssl_crypto_tests\": \"f12ff3549d4adaa7f10ad9b33ffbb5f0a4d74604\", \"boringssl_ssl_tests\": \"6fbcd485beabb6dd09bf961e8864ae0094cbc0a8\", \"browser_tests\": \"4a7b3160625036be043b50f5122cffa319e76678\", \"capture_unittests\": \"255aa84bcd23baccdf86360f081673bc028d8c5d\", \"cast_unittests\": \"893727719154cd35a0382bbb47c925c6e3b0df15\", \"cc_unittests\": \"97971600307c23a0b0f34b81af4d0079af48776a\", \"chrome_app_unittests\": \"9643c79cbc7cb0cc25c880d2d27e2feb43bb1e07\", \"chromedriver_unittests\": \"b1914a4a001c69e000263e29346b081ab608139e\", \"chromeos_components_unittests\": \"d5be31da37f3e9096fff32730475a8f16ae29b56\", \"chromeos_unittests\": \"25db8070d2b457a2c81867d854c15fd237d98b46\", \"components_browsertests\": \"8a87f77711428b2f13855cd9d8f446dabc2f2f24\", \"components_unittests\": \"a377d6ca5cb903caa2de1537a2ff58ad3cb06a19\", \"compositor_unittests\": \"8cfd9597355c4be4bd144442395d7ed076217ddd\", \"content_browsertests\": \"7563009804c80c9d58148b90e4ed37608873f27e\", \"content_unittests\": \"13a2932781a000b3b6f71f8abf96c02c1a2a51e0\", \"crashpad_tests\": \"7fa9abd985f58c1d50e40225d54c95eea123c6bd\", \"crypto_unittests\": \"53b837ee02b6160f6aef8b76eda4a2b02a339261\", \"dbus_unittests\": \"015920727bc0c3c412121cc8040f5296163737fc\", \"device_unittests\": \"7456a2d9926c8744fac76e193fde96fdf0c44fea\", \"display_unittests\": \"b064d8fc04595116d39dca526b52be9ad99bc070\", \"events_unittests\": \"73905fce961e7376e91a709bbf13139192eb03fa\", \"exo_unittests\": \"4d550d33f901932e42a592f6397241c8f0e36de8\", \"extensions_browsertests\": \"789d2078c946bbf900071343caae7d8779f23d81\", \"extensions_unittests\": \"d3ebc5841f15506a39116b81d8f1b9c4944f0ca1\", \"filesystem_service_unittests\": \"09a7311ede342ab753e32ee41be8971cddc1a612\", \"gcm_unit_tests\": \"18f7546a61d84a92de1606ada0b9d2c2947b1b01\", \"gfx_unittests\": \"8750f6ebe25380d3bd7d0e4133b4a05342c35358\", \"gin_unittests\": \"718969b5bbcaa191b0dfb8a86d23dc4b471b5eb1\", \"gl_unittests_ozone\": \"c7a6fb172734bb4f209fb760cddfb5145dc78452\", \"google_apis_unittests\": \"b59e795d1b46ae42619aac2ed79d87453af19efb\", \"gpu_unittests\": \"c4035643395fea03bd14e5a05b723a24806065cb\", \"gwp_asan_unittests\": \"e46e56f0b682b224bb789233adb646cb4664f787\", \"interactive_ui_tests\": \"f114c7511ceeef78be9fd0389084857ce2a44390\", \"ipc_tests\": \"e48d1c1cc9676935c10c45f2b608de037c2ab240\", \"jingle_unittests\": \"196362a688a53b692c9125c50089eb1e9826d92a\", \"keyboard_unittests\": \"1812567bb71c666f9058a04251d0ec21c804adbb\", \"latency_unittests\": \"9cf5935f4c7b3be9830ba57912479864e8181e88\", \"libjingle_xmpp_unittests\": \"c609a5678f23962adb7efc23e2e8aa3894b1a327\", \"liburlpattern_unittests\": \"e9d3f4d2f4dc0d87c27553d99b8251c1ac519f55\", \"media_blink_unittests\": \"039996c862a240a4c1ccd973516cc1e91984ed55\", \"media_unittests\": \"b36b462a17781ec4e108674c88de025c7df5e6be\", \"message_center_unittests\": \"0814b8d600ab5a1134edef8bedaa8edf16493e07\", \"midi_unittests\": \"c75271bfadb17bbbe32b0b7d0ab188ebcbbc6517\", \"mojo_core_unittests\": \"baacf18278d1fd8c4338d782241542f290e3c904\", \"mojo_unittests\": \"c5fcfb20612ba1704021b48fb0a604b4731a103b\", \"nacl_helper_nonsfi_unittests\": \"60efae5b4f086a18d1015c5fee4cea5c7f1106f9\", \"nacl_loader_unittests\": \"e2691b15bd42f991c313e006301c1cf270a31dd3\", \"native_theme_unittests\": \"6263cbf6fdff199ad99af99d2c5991a95b6cd7f0\", \"net_unittests\": \"9e4e78dc96a129c3c36b47c9edddac0f2420916d\", \"ozone_gl_unittests\": \"59bf7380cfded7bfe0f6960e57e6168f33e9cc34\", \"ozone_unittests\": \"9d5b7882d7efc20c3bf10e6d8132ca4352ee8b6f\", \"ozone_x11_unittests\": \"47f1c410f0e747b218f15357984587bbdded97f8\", \"pdf_unittests\": \"8e97dcc438f5269f1110bcd64da942138f99e4d8\", \"perfetto_unittests\": \"528ba31a71cad5f10baac1820112e399b98f4f68\", \"ppapi_unittests\": \"d4ee3be4c0b488871c0efd0153dfec836f10b290\", \"printing_unittests\": \"868e1441e44455f30c6166aa5694c7ff9923cb50\", \"remoting_unittests\": \"02b83214a92704746977ed0302df24cbe3571fae\", \"sandbox_linux_unittests\": \"bc5c01fe2be6e482151379b7db32500869eb968d\", \"service_manager_unittests\": \"b1be28c95678b3ed8b57da461932720bab2368e0\", \"services_unittests\": \"5f4e84461b3547674037184756108a641f1e408a\", \"shell_dialogs_unittests\": \"8b5eba4a23a304ce391d113a34bc62e7279696cf\", \"shell_encryption_unittests\": \"0711da466cb5b6836c839832ecd2c4523bf66c3b\", \"skia_unittests\": \"7a1b823d61b578713f004f6a1be9fc0f74f2edd6\", \"snapshot_unittests\": \"0cc73e90644572dc0eadf543296a0c295b3cb461\", \"sql_unittests\": \"21c770f908d63e94b1cb9c731e8e544b4e97ee3b\", \"storage_unittests\": \"ff53526d7f1f220cd6e04c666f8408cffbbb48c9\", \"sync_integration_tests\": \"8399f1371975973e2e52f5a1f5745389b041face\", \"traffic_annotation_auditor_unittests\": \"1cc5bca07180516c5d6d35bc80795c1cc5073109\", \"ui_base_unittests\": \"ef9adde7ebc3a68cb447967c85fb5ca9fdc5ff12\", \"ui_chromeos_unittests\": \"6b45f60ca5c8384c45e8ea8dd231d3becb3ec897\", \"ui_touch_selection_unittests\": \"cdf63ff320be7a6775bc981f253d4e877d6e3a15\", \"unit_tests\": \"10d10a68dbc736493c661803d27634c17a175dfb\", \"url_unittests\": \"6c4995f2aa50361906f15ab7a44eba75e77d1c16\", \"usage_time_limit_unittests\": \"fdfcedb56fa6de8c79584837538464045ed8f4b4\", \"views_unittests\": \"2c9a95220e934c4a3332fbb80476c88d49a00ca7\", \"viz_unittests\": \"8280f5976597fb31185d43b225e4aad7df0e526e\", \"wayland_client_perftests\": \"f021e7457502ea286b05ddfee7e3436d21b4d3b8\", \"wm_unittests\": \"5fca7a27b105727430dc5a4a83261282a06cdcab\", \"wtf_unittests\": \"6d84584e3b7f193c9860fc499e674bdd284f3fbe\", \"zlib_unittests\": \"64b451fa316d9483e46d4f32a69c413479aba0f6\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_219e0ffc8c25f5e0b87c50b06543131c770ba4c60d610054ab97561314494a41_v2\", \"builder_94fa3119a28f4651cdd4fc5b981a64c69b26c151212072333439362290628993_v2\", \"builder_abc31495eda36a292af84de2d2556c5a9957390958fb6f471694dbdb8b84ffff_v2\", \"builder_eb9e31050ddbebce4ba6cbaea9a0445903ee5f3e90bdb319e3517a7851b1b7f7_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-23-q58c\"], \"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\": [\"5672-4713de1\"], \"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- HoldingSpace/FilesAppBrowserTest.Test/holdingSpaceWelcomeBannerWithFeatureEnabled\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1611745137638810",
"status": "COMPLETED",
"status_changed_ts": "1611745138392201",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/44942",
"builder:linux-chromeos-rel",
"buildset:commit/git/68470500ede1f454438f41e38ee13c555056ed1e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/68470500ede1f454438f41e38ee13c555056ed1e",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9022386553721228064",
"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/8856956491601149296/+/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:515c4ffd87ba4210",
"user_agent:luci-scheduler"
],
"updated_ts": "1611747852180243",
"url": "https://ci.chromium.org/b/8856956491601149296",
"utcnow_ts": "1611747852912080"
}
}
[11:44:12.950] Invocation finished in 45m59.716823952s with status FAILED