[19:43:14.431] New invocation is queued and will start shortly
[19:43:16.079] Starting the invocation (attempt 1)
[19:43:16.115] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[19:43:16.115] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[19:43:16.115] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9018729643689534496",
"parameters_json": "{\"builder_name\":\"linux-chromeos-rel\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"1d82a9d453b5c0bb806275c9892c41998b71ff1e\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-rel",
"scheduler_invocation_id:9018729643689534496",
"scheduler_job_id:chromium/linux-chromeos-rel",
"user_agent:luci-scheduler",
"buildset:commit/git/1d82a9d453b5c0bb806275c9892c41998b71ff1e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/1d82a9d453b5c0bb806275c9892c41998b71ff1e",
"gitiles_ref:refs/heads/master"
]
}
[19:43:17.726] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1615232596331120",
"id": "8853299581027422064",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"1d82a9d453b5c0bb806275c9892c41998b71ff1e\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1615232597405385",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/45998",
"builder:linux-chromeos-rel",
"buildset:commit/git/1d82a9d453b5c0bb806275c9892c41998b71ff1e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/1d82a9d453b5c0bb806275c9892c41998b71ff1e",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9018729643689534496",
"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/8853299581027422064/+/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": "1615232597405510",
"url": "https://ci.chromium.org/b/8853299581027422064",
"utcnow_ts": "1615232597701834"
}
}
[19:43:17.726] Task URL: https://ci.chromium.org/b/8853299581027422064
[19:43:17.726] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:2:0) after 1m0s
[19:44:17.907] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:2:0)
[19:44:17.907] Timer tick, asking Buildbucket for the build status
[19:44:18.127] Build 8853299581027422064: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:44:18.127] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:3:0) after 1m0s
[19:45:18.153] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:3:0)
[19:45:18.153] Timer tick, asking Buildbucket for the build status
[19:45:18.349] Build 8853299581027422064: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:45:18.349] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:4:0) after 1m0s
[19:46:18.385] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:4:0)
[19:46:18.385] Timer tick, asking Buildbucket for the build status
[19:46:19.956] Build 8853299581027422064: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:46:19.956] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:5:0) after 1m0s
[19:47:20.202] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:5:0)
[19:47:20.202] Timer tick, asking Buildbucket for the build status
[19:47:20.286] Build 8853299581027422064: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:47:20.286] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:6:0) after 1m0s
[19:48:20.331] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:6:0)
[19:48:20.331] Timer tick, asking Buildbucket for the build status
[19:48:20.458] Build 8853299581027422064: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:48:20.458] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:7:0) after 1m0s
[19:49:20.521] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:7:0)
[19:49:20.521] Timer tick, asking Buildbucket for the build status
[19:49:20.727] Build 8853299581027422064: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:49:20.727] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:8:0) after 1m0s
[19:50:20.792] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:8:0)
[19:50:20.792] Timer tick, asking Buildbucket for the build status
[19:50:21.026] Build 8853299581027422064: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:50:21.026] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:9:0) after 1m0s
[19:51:21.076] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:9:0)
[19:51:21.076] Timer tick, asking Buildbucket for the build status
[19:51:21.225] Build 8853299581027422064: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[19:51:21.225] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:10:0) after 1m0s
[19:51:32.468] Received PubSub notification, asking Buildbucket for the build status
[19:51:32.646] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:52:21.240] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:10:0)
[19:52:21.240] Timer tick, asking Buildbucket for the build status
[19:52:21.312] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:52:21.312] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:12:0) after 1m0s
[19:53:21.391] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:12:0)
[19:53:21.391] Timer tick, asking Buildbucket for the build status
[19:53:21.470] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:53:21.470] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:13:0) after 1m0s
[19:54:21.491] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:13:0)
[19:54:21.491] Timer tick, asking Buildbucket for the build status
[19:54:21.964] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:54:21.964] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:14:0) after 1m0s
[19:55:22.130] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:14:0)
[19:55:22.130] Timer tick, asking Buildbucket for the build status
[19:55:22.193] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:55:22.193] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:15:0) after 1m0s
[19:56:22.233] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:15:0)
[19:56:22.233] Timer tick, asking Buildbucket for the build status
[19:56:22.312] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:56:22.312] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:16:0) after 1m0s
[19:57:22.417] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:16:0)
[19:57:22.417] Timer tick, asking Buildbucket for the build status
[19:57:22.636] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:57:22.636] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:17:0) after 1m0s
[19:58:22.705] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:17:0)
[19:58:22.705] Timer tick, asking Buildbucket for the build status
[19:58:22.888] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:58:22.888] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:18:0) after 1m0s
[19:59:23.016] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:18:0)
[19:59:23.016] Timer tick, asking Buildbucket for the build status
[19:59:23.132] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:59:23.132] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:19:0) after 1m0s
[20:00:23.169] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:19:0)
[20:00:23.169] Timer tick, asking Buildbucket for the build status
[20:00:23.251] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:00:23.251] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:20:0) after 1m0s
[20:01:23.418] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:20:0)
[20:01:23.418] Timer tick, asking Buildbucket for the build status
[20:01:23.517] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:01:23.517] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:21:0) after 1m0s
[20:02:24.027] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:21:0)
[20:02:24.027] Timer tick, asking Buildbucket for the build status
[20:02:24.236] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:02:24.236] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:22:0) after 1m0s
[20:03:25.950] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:22:0)
[20:03:25.950] Timer tick, asking Buildbucket for the build status
[20:03:26.033] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:03:26.033] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:23:0) after 1m0s
[20:04:26.111] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:23:0)
[20:04:26.111] Timer tick, asking Buildbucket for the build status
[20:04:26.243] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:04:26.243] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:24:0) after 1m0s
[20:05:26.301] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:24:0)
[20:05:26.301] Timer tick, asking Buildbucket for the build status
[20:05:26.512] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:05:26.512] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:25:0) after 1m0s
[20:06:26.564] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:25:0)
[20:06:26.564] Timer tick, asking Buildbucket for the build status
[20:06:26.639] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:06:26.639] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:26:0) after 1m0s
[20:07:26.677] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:26:0)
[20:07:26.677] Timer tick, asking Buildbucket for the build status
[20:07:26.962] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:07:26.962] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:27:0) after 1m0s
[20:08:27.104] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:27:0)
[20:08:27.104] Timer tick, asking Buildbucket for the build status
[20:08:27.420] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:08:27.420] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:28:0) after 1m0s
[20:09:27.443] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:28:0)
[20:09:27.443] Timer tick, asking Buildbucket for the build status
[20:09:27.513] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:09:27.513] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:29:0) after 1m0s
[20:10:27.556] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:29:0)
[20:10:27.556] Timer tick, asking Buildbucket for the build status
[20:10:27.675] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:10:27.675] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:30:0) after 1m0s
[20:11:27.699] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:30:0)
[20:11:27.699] Timer tick, asking Buildbucket for the build status
[20:11:27.838] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:11:27.838] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:31:0) after 1m0s
[20:12:27.900] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:31:0)
[20:12:27.900] Timer tick, asking Buildbucket for the build status
[20:12:28.428] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:12:28.428] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:32:0) after 1m0s
[20:13:28.464] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:32:0)
[20:13:28.464] Timer tick, asking Buildbucket for the build status
[20:13:28.550] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:13:28.550] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:33:0) after 1m0s
[20:14:28.569] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:33:0)
[20:14:28.569] Timer tick, asking Buildbucket for the build status
[20:14:29.039] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:14:29.039] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:34:0) after 1m0s
[20:15:29.059] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:34:0)
[20:15:29.059] Timer tick, asking Buildbucket for the build status
[20:15:29.241] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:15:29.241] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:35:0) after 1m0s
[20:16:29.273] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:35:0)
[20:16:29.273] Timer tick, asking Buildbucket for the build status
[20:16:29.365] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:16:29.365] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:36:0) after 1m0s
[20:17:29.396] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:36:0)
[20:17:29.396] Timer tick, asking Buildbucket for the build status
[20:17:29.718] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:17:29.718] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:37:0) after 1m0s
[20:18:30.430] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:37:0)
[20:18:30.430] Timer tick, asking Buildbucket for the build status
[20:18:30.499] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:18:30.499] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:38:0) after 1m0s
[20:19:30.901] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:38:0)
[20:19:30.901] Timer tick, asking Buildbucket for the build status
[20:19:31.074] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:19:31.074] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:39:0) after 1m0s
[20:20:31.131] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:39:0)
[20:20:31.131] Timer tick, asking Buildbucket for the build status
[20:20:31.529] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:20:31.529] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:40:0) after 1m0s
[20:21:31.568] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:40:0)
[20:21:31.568] Timer tick, asking Buildbucket for the build status
[20:21:31.751] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:21:31.751] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:41:0) after 1m0s
[20:22:31.817] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:41:0)
[20:22:31.817] Timer tick, asking Buildbucket for the build status
[20:22:32.202] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:22:32.202] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:42:0) after 1m0s
[20:23:32.198] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:42:0)
[20:23:32.198] Timer tick, asking Buildbucket for the build status
[20:23:32.370] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:23:32.370] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:43:0) after 1m0s
[20:24:32.407] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:43:0)
[20:24:32.407] Timer tick, asking Buildbucket for the build status
[20:24:32.488] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:24:32.488] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:44:0) after 1m0s
[20:25:32.505] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:44:0)
[20:25:32.505] Timer tick, asking Buildbucket for the build status
[20:25:32.595] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:25:32.595] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:45:0) after 1m0s
[20:26:32.611] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:45:0)
[20:26:32.611] Timer tick, asking Buildbucket for the build status
[20:26:32.703] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:26:32.703] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:46:0) after 1m0s
[20:27:32.737] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:46:0)
[20:27:32.737] Timer tick, asking Buildbucket for the build status
[20:27:32.868] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:27:32.868] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:47:0) after 1m0s
[20:28:32.907] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:47:0)
[20:28:32.907] Timer tick, asking Buildbucket for the build status
[20:28:33.118] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:28:33.118] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:48:0) after 1m0s
[20:29:33.121] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:48:0)
[20:29:33.121] Timer tick, asking Buildbucket for the build status
[20:29:33.221] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:29:33.221] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:49:0) after 1m0s
[20:30:34.153] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:49:0)
[20:30:34.153] Timer tick, asking Buildbucket for the build status
[20:30:34.266] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:30:34.266] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:50:0) after 1m0s
[20:31:34.455] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:50:0)
[20:31:34.455] Timer tick, asking Buildbucket for the build status
[20:31:34.533] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:31:34.533] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:51:0) after 1m0s
[20:32:34.845] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:51:0)
[20:32:34.845] Timer tick, asking Buildbucket for the build status
[20:32:35.050] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:32:35.050] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:52:0) after 1m0s
[20:33:35.172] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:52:0)
[20:33:35.172] Timer tick, asking Buildbucket for the build status
[20:33:35.283] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:33:35.283] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:53:0) after 1m0s
[20:34:35.356] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:53:0)
[20:34:35.356] Timer tick, asking Buildbucket for the build status
[20:34:35.627] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:34:35.627] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:54:0) after 1m0s
[20:35:35.741] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:54:0)
[20:35:35.741] Timer tick, asking Buildbucket for the build status
[20:35:36.000] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:35:36.000] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:55:0) after 1m0s
[20:36:35.980] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:55:0)
[20:36:35.980] Timer tick, asking Buildbucket for the build status
[20:36:36.126] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:36:36.126] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:56:0) after 1m0s
[20:37:36.144] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:56:0)
[20:37:36.144] Timer tick, asking Buildbucket for the build status
[20:37:36.458] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:37:36.458] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:57:0) after 1m0s
[20:38:36.532] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:57:0)
[20:38:36.532] Timer tick, asking Buildbucket for the build status
[20:38:36.615] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:38:36.615] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:58:0) after 1m0s
[20:39:36.684] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:58:0)
[20:39:36.684] Timer tick, asking Buildbucket for the build status
[20:39:36.792] Build 8853299581027422064: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:39:36.792] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-rel:9018729643689534496:59:0) after 1m0s
[20:39:43.846] Received PubSub notification, asking Buildbucket for the build status
[20:39:43.927] Build 8853299581027422064: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[20:39:43.927] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1615235983245560",
"created_by": "project:chromium",
"created_ts": "1615232596331120",
"failure_reason": "BUILD_FAILURE",
"id": "8853299581027422064",
"parameters_json": "{\"builder_name\": \"linux-chromeos-rel\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"1d82a9d453b5c0bb806275c9892c41998b71ff1e\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**browser_tests** failed because of:\\n\\n- DemoSetupArcSupportedTest.ShowOfflineSetupOptionOnNetworkList\"}, \"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\": \"1d82a9d453b5c0bb806275c9892c41998b71ff1e\", \"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-9-oniv\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-rel\", \"buildnumber\": 45998, \"got_angle_revision\": \"9bc86c50f283560a3294c256bacccc1accb5bc94\", \"got_dawn_revision\": \"010fd1a8d7c7dd4e8fabe73546be78c45b6419c2\", \"got_nacl_revision\": \"abf3277f295c6c87f0b103f291ed5e3e73933b76\", \"got_revision\": \"1d82a9d453b5c0bb806275c9892c41998b71ff1e\", \"got_revision_cp\": \"refs/heads/master@{#860809}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"de7d5775ab25234a2c14d061e0cda342248a0e6d\", \"got_v8_revision\": \"ad7609182d57f01afd2e2769869b7c3e23282119\", \"got_v8_revision_cp\": \"refs/heads/9.1.65@{#1}\", \"got_webrtc_revision\": \"3208bf102b75e8ec1eaa6640dfa3b545310b1e02\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33382}\", \"is_cached\": true, \"isolate_server\": \"https://isolateserver.appspot.com\", \"mirrored_builders\": [\"tryserver.chromium.chromiumos:linux-chromeos-inverse-fieldtrials-fyi-rel\", \"tryserver.chromium.chromiumos:linux-chromeos-rel\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"1d82a9d453b5c0bb806275c9892c41998b71ff1e\", \"swarm_hashes_refs/heads/master(at){#860809}_without_patch\": {\"absl_hardening_tests\": \"42033aee87f14f7caae70e62ce07b154032900b0\", \"accessibility_unittests\": \"e00fc7c9b50cfdd4f6ed1a8a532483de8a98546c\", \"angle_unittests\": \"ae8a186f45d0e569998715fdeb3323f25ec421e1\", \"app_list_unittests\": \"cec734e3ff915313398f1e5264791e4c70424f4a\", \"app_shell_unittests\": \"dd2791def3c2d3beb4b4226cafc2018517cf7719\", \"ash_unittests\": \"93afbbe58d1df6740d6bf0926961e0ce0e0e63b5\", \"aura_unittests\": \"2f6e18ca51deea85eb3db6ac241f7e921ed8c399\", \"base_unittests\": \"bc1007cb1762c1fde59ea898820b6142fefa7d7b\", \"base_util_unittests\": \"f038265b759aa2a44fb55f4b054878943e935c27\", \"blink_common_unittests\": \"cad77fcd7ac487e9891624a280987571fbc3c672\", \"blink_fuzzer_unittests\": \"778c4876db0ad4f3edd3a36a90a712ff7a7958bc\", \"blink_heap_unittests\": \"122c53c5eee0d3e048f63f9687c80bef989250ea\", \"blink_platform_unittests\": \"1eaa02a513563cdbf9b352fec856727838a7b180\", \"blink_unittests\": \"c9c804a67e49534a3848291cf962ca2ef4834f26\", \"boringssl_crypto_tests\": \"04d26bf044b9c9cba6645718c183748dc8917c6a\", \"boringssl_ssl_tests\": \"883a3697a0e11e7f91411a460bed70f7730065e2\", \"browser_tests\": \"f978b3d1a664336d756c2a3c778b142c740ab485\", \"capture_unittests\": \"443cc16063e5d6b4efea547d3ed23f2fbad45792\", \"cast_unittests\": \"f1d6f417f35d6bd32cd253d024c427a1363a5286\", \"cc_unittests\": \"966e66914566537dbd56d1b60b181a21c0150608\", \"chrome_app_unittests\": \"8328d4bda152f51884ad6221a2217d50b69c1fcc\", \"chromedriver_unittests\": \"fa1544b77879412805d9094d8d96a9258a49c36a\", \"chromeos_components_unittests\": \"ab262c1af50f35d854dd508a0f49b23197d83a5a\", \"chromeos_unittests\": \"90502d729f539f32bfbadbfa86b94c23412adc79\", \"color_unittests\": \"ac3824aa95cc57ae914501408bc71e3b67398f2c\", \"components_browsertests\": \"d5a8618e7c355e04294cdb54926117da44b2d5f7\", \"components_unittests\": \"055db2d2f5004cc41119e5ff4ec2511acf27da86\", \"compositor_unittests\": \"e481a3bf07bef26d28d04306972a62a51301a044\", \"content_browsertests\": \"4b37c809052651f588370f4fb115027ece23f2eb\", \"content_unittests\": \"c8b85ec1f7bcdcb6e304c1b942ab2eff5fad9958\", \"crashpad_tests\": \"bed9a7f8091a7b7043cf2486d8ba7a1f30211a81\", \"crypto_unittests\": \"39f801dfad3f82028b384212eed182d094b979bb\", \"dbus_unittests\": \"557c61afa249290d1caa8d183c2190badb06714f\", \"device_unittests\": \"b17b62c53f37df3e77112bb08024b0f838772a4a\", \"display_unittests\": \"552ae167805885629e5ad9dbaab6efee69803763\", \"events_unittests\": \"c8f7e70ed7f645e6ee2926f50bcb7efcd541472e\", \"exo_unittests\": \"4f170879f196b0bfe5ba9a41028f109d6e8f5284\", \"extensions_browsertests\": \"3dc418b79f31d1e6e83d6559897effcc2f8690b6\", \"extensions_unittests\": \"386f1bfa8032c52a777e9f9e2adc6c336493ac86\", \"filesystem_service_unittests\": \"04aa712b4f93a427b7f3187aed405690545ca3d2\", \"gcm_unit_tests\": \"b3d78673c3b2b99a7431bd9dc6600e55cbcce320\", \"gfx_unittests\": \"4b031c9eb61144b8ff2649736f77fb0be42839b0\", \"gin_unittests\": \"329dec55a833377164ee5c63d70c22b0d8ccca8b\", \"gl_unittests_ozone\": \"53eed5e60156d5fe198f5c43ce01070d05b9c5b2\", \"google_apis_unittests\": \"fbdf6ae15f6d336859c99a31ae50bb123aaf1d50\", \"gpu_unittests\": \"bffb86921caa8b6b58a45582fd3299dab44c0114\", \"gwp_asan_unittests\": \"1232c099c48f9b072d6f9459c4325b964cb9dd36\", \"interactive_ui_tests\": \"4be7a546ffe27720c2d985a521bcafe65dae5027\", \"ipc_tests\": \"526671e855b620836875a6d9fe77f6231ff77563\", \"jingle_unittests\": \"68558e0950e9b78b696f37de8b3d6eb8e9ec86da\", \"keyboard_unittests\": \"c410fd602052c24ac6c56e7b5b448e3ba648eb45\", \"latency_unittests\": \"6b873ed11ccc03b9be66ea57e1a37c58f1884309\", \"libjingle_xmpp_unittests\": \"058025b421a779e83a418359c5e4222ed321e233\", \"liburlpattern_unittests\": \"feb9f41ec9af2f92127c0d8cb7dea692021e1e48\", \"media_blink_unittests\": \"75c1b37a2cdc03156396816339736e82cf525dab\", \"media_unittests\": \"651ee851db7360f376d00c42e4c6bf0643448eaf\", \"message_center_unittests\": \"8445a9a85b5f2c9cb2eb0e5af28b7b8cb951c3d9\", \"midi_unittests\": \"63d809856d9f4f0c9914050daa2cc001f6293a9f\", \"mojo_core_unittests\": \"469ee37ca12e97e3ff0055491a34a84f9743409b\", \"mojo_unittests\": \"48e29afcbccfb2efa514fc7f792568fee095151d\", \"nacl_helper_nonsfi_unittests\": \"be286d5c9bf95fd06396cd13dfb57a993fbacb37\", \"nacl_loader_unittests\": \"4bcd369b5229efba8dd1b865af79a7f96744e8b8\", \"native_theme_unittests\": \"8f6e8deca768eb8fef7794b3a951d216225a3d58\", \"net_unittests\": \"f3f67d18f5dad696f8631de2bc2d52d158bd0677\", \"ozone_gl_unittests\": \"1c7930132e63d02062e6d996571a7a0be31fd62f\", \"ozone_unittests\": \"4eed2a21e598f83f10ff06def6e97b3ad280f776\", \"ozone_x11_unittests\": \"d83badd7c3c31427800b9e7c969036a258a5a852\", \"pdf_unittests\": \"3f378a96a9a063e1aa2014b5c05b3deed65becb4\", \"perfetto_unittests\": \"da691ad0c558d7d71f84a9c733901e170837fbb0\", \"ppapi_unittests\": \"cb7b1ea9c5655b2f4af4e99e76560414c7987012\", \"printing_unittests\": \"778d3e366a501bb542b8f3e91b6700bd3608d486\", \"remoting_unittests\": \"7e846602f6e90b7505d43f2321807899a05b9bc6\", \"sandbox_linux_unittests\": \"023c06d1e658192614e99797d9d20a0a9aeeeeff\", \"service_manager_unittests\": \"112071f5e91e98f31bb59553bfc8c14da264a498\", \"services_unittests\": \"aae0fb10ce4d5d4f7370dcadbae8667ed72dfe79\", \"shell_dialogs_unittests\": \"410b59936c67a4d4a8c722f7647b47f6004f1130\", \"shell_encryption_unittests\": \"8a970c6110ce7d4908b468486e311d726372cd66\", \"skia_unittests\": \"785e4dbaed6c83a144c619f83bcb93a14d15283a\", \"snapshot_unittests\": \"128a63d7761f48bdffafa84d86bde57dcba52721\", \"sql_unittests\": \"147f27658d54072471e57c99ccb2163e5cda7cfd\", \"storage_unittests\": \"18236dd348c6ca001b34d5a7307002a584b73146\", \"sync_integration_tests\": \"f766972856a56fcd482f335a818de35bf64c5b72\", \"traffic_annotation_auditor_unittests\": \"5576be0a170faf8f1a5087779ee63506b7607790\", \"ui_base_unittests\": \"f53a28b708a27683f34bbbe81e4e64c587d7d8ed\", \"ui_chromeos_unittests\": \"049c1c3324783b8eed4953c5548ed844e129a219\", \"ui_touch_selection_unittests\": \"3747b62fff16ca5c8767d483fb507983f854b451\", \"unit_tests\": \"cba142ef0c7d05c3f6059933ed11d15901ada7b8\", \"url_unittests\": \"d40284dcc4f48ffc011e2c73a1048075c611c1b3\", \"usage_time_limit_unittests\": \"bbd91edb9627fdab16fed3397fb62d64ee0baa63\", \"views_unittests\": \"3be3fd83efaf0608263f1b45da23b60c03a493ce\", \"viz_unittests\": \"484df7f6c73fae8e7230da60633f401a7e149b15\", \"wayland_client_perftests\": \"a8b4ede5bec79616fc84cdd236b001ec26c1a73e\", \"wayland_client_tests\": \"e5f7026f11a576326fb0c3caf7fb00b42700f194\", \"wm_unittests\": \"91bbe0fd0eed4368a6ee1f2baf8043b5d1101fc6\", \"wtf_unittests\": \"9f9cb3abd684d3d1b10a73f794fe8e26afe02d3e\", \"zlib_unittests\": \"41f1d8fdbf0390c74e6d2133d19a39292f2a1c8f\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_7d3316d3e62555e2d69f10e77e29eb3429b9b1f483dcbd92e41f25657b896dff_v2\", \"builder_8a4e9d5e5a37a98f1521a3a36ddb77cf3e170b8528c1bf60d5d419f9d69b17e3_v2\", \"builder_94fa3119a28f4651cdd4fc5b981a64c69b26c151212072333439362290628993_v2\", \"builder_ced96a74d42b033f0c2af7945046235886933cd52f84e329d5240b2ff40f9657_v2\", \"builder_cfdb55a1f65ed072d1fe07f7fc1107a97a5e848a8d1b6b0015401ab521f6b501_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-9-oniv\"], \"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\": [\"5744-5c0a4b4\"], \"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- DemoSetupArcSupportedTest.ShowOfflineSetupOptionOnNetworkList\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1615233091804114",
"status": "COMPLETED",
"status_changed_ts": "1615233092251159",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-rel/45998",
"builder:linux-chromeos-rel",
"buildset:commit/git/1d82a9d453b5c0bb806275c9892c41998b71ff1e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/1d82a9d453b5c0bb806275c9892c41998b71ff1e",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9018729643689534496",
"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/8853299581027422064/+/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:522c2f095b4aa110",
"user_agent:luci-scheduler"
],
"updated_ts": "1615235983246041",
"url": "https://ci.chromium.org/b/8853299581027422064",
"utcnow_ts": "1615235983917360"
}
}
[20:39:43.927] Invocation finished in 56m29.518297234s with status FAILED