[18:43:32.299] New invocation is queued and will start shortly
[18:43:33.408] Starting the invocation (attempt 1)
[18:43:33.451] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[18:43:33.451] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[18:43:33.452] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9030692199419271056",
"parameters_json": "{\"builder_name\":\"linux-chromeos-dbg\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"d943b2e67ee2494c269149a9cd78b122823f535d\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-dbg",
"scheduler_invocation_id:9030692199419271056",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"user_agent:luci-scheduler",
"buildset:commit/git/d943b2e67ee2494c269149a9cd78b122823f535d",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/d943b2e67ee2494c269149a9cd78b122823f535d",
"gitiles_ref:refs/heads/master"
]
}
[18:43:34.173] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1603824213532121",
"id": "8865262137429638624",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"d943b2e67ee2494c269149a9cd78b122823f535d\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1603824213924499",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/21033",
"builder:linux-chromeos-dbg",
"buildset:commit/git/d943b2e67ee2494c269149a9cd78b122823f535d",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/d943b2e67ee2494c269149a9cd78b122823f535d",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9030692199419271056",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8865262137429638624/+/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": "1603824213924746",
"url": "https://ci.chromium.org/b/8865262137429638624",
"utcnow_ts": "1603824214165533"
}
}
[18:43:34.173] Task URL: https://ci.chromium.org/b/8865262137429638624
[18:43:34.173] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:2:0) after 1m0s
[18:43:37.238] Received PubSub notification, asking Buildbucket for the build status
[18:43:37.485] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:44:34.224] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:2:0)
[18:44:34.224] Timer tick, asking Buildbucket for the build status
[18:44:34.332] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:44:34.332] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:4:0) after 1m0s
[18:45:34.394] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:4:0)
[18:45:34.394] Timer tick, asking Buildbucket for the build status
[18:45:34.843] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:45:34.843] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:5:0) after 1m0s
[18:46:34.853] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:5:0)
[18:46:34.853] Timer tick, asking Buildbucket for the build status
[18:46:35.052] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:46:35.052] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:6:0) after 1m0s
[18:47:35.152] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:6:0)
[18:47:35.152] Timer tick, asking Buildbucket for the build status
[18:47:35.267] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:47:35.267] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:7:0) after 1m0s
[18:48:35.339] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:7:0)
[18:48:35.339] Timer tick, asking Buildbucket for the build status
[18:48:35.665] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:48:35.665] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:8:0) after 1m0s
[18:49:35.793] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:8:0)
[18:49:35.793] Timer tick, asking Buildbucket for the build status
[18:49:35.859] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:49:35.859] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:9:0) after 1m0s
[18:50:36.017] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:9:0)
[18:50:36.018] Timer tick, asking Buildbucket for the build status
[18:50:36.083] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:50:36.083] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:10:0) after 1m0s
[18:51:36.293] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:10:0)
[18:51:36.294] Timer tick, asking Buildbucket for the build status
[18:51:36.356] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:51:36.356] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:11:0) after 1m0s
[18:52:36.496] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:11:0)
[18:52:36.496] Timer tick, asking Buildbucket for the build status
[18:52:36.808] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:52:36.808] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:12:0) after 1m0s
[18:53:36.862] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:12:0)
[18:53:36.862] Timer tick, asking Buildbucket for the build status
[18:53:37.033] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:53:37.033] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:13:0) after 1m0s
[18:54:37.063] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:13:0)
[18:54:37.063] Timer tick, asking Buildbucket for the build status
[18:54:37.159] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:54:37.159] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:14:0) after 1m0s
[18:55:37.203] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:14:0)
[18:55:37.203] Timer tick, asking Buildbucket for the build status
[18:55:37.281] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:55:37.281] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:15:0) after 1m0s
[18:56:37.315] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:15:0)
[18:56:37.315] Timer tick, asking Buildbucket for the build status
[18:56:37.425] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:56:37.425] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:16:0) after 1m0s
[18:57:37.660] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:16:0)
[18:57:37.660] Timer tick, asking Buildbucket for the build status
[18:57:38.713] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:57:38.713] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:17:0) after 1m0s
[18:58:38.878] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:17:0)
[18:58:38.878] Timer tick, asking Buildbucket for the build status
[18:58:39.475] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:58:39.475] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:18:0) after 1m0s
[18:59:39.527] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:18:0)
[18:59:39.527] Timer tick, asking Buildbucket for the build status
[18:59:39.636] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:59:39.636] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:19:0) after 1m0s
[19:00:39.686] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:19:0)
[19:00:39.686] Timer tick, asking Buildbucket for the build status
[19:00:40.962] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:00:40.962] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:20:0) after 1m0s
[19:01:41.033] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:20:0)
[19:01:41.033] Timer tick, asking Buildbucket for the build status
[19:01:41.092] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:01:41.092] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:21:0) after 1m0s
[19:02:41.175] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:21:0)
[19:02:41.175] Timer tick, asking Buildbucket for the build status
[19:02:41.630] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:02:41.630] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:22:0) after 1m0s
[19:03:41.842] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:22:0)
[19:03:41.842] Timer tick, asking Buildbucket for the build status
[19:03:42.217] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:03:42.217] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:23:0) after 1m0s
[19:04:42.300] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:23:0)
[19:04:42.301] Timer tick, asking Buildbucket for the build status
[19:04:42.785] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:04:42.785] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:24:0) after 1m0s
[19:05:42.778] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:24:0)
[19:05:42.778] Timer tick, asking Buildbucket for the build status
[19:05:42.849] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:05:42.849] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:25:0) after 1m0s
[19:06:42.879] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:25:0)
[19:06:42.879] Timer tick, asking Buildbucket for the build status
[19:06:42.959] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:06:42.959] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:26:0) after 1m0s
[19:07:42.974] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:26:0)
[19:07:42.974] Timer tick, asking Buildbucket for the build status
[19:07:43.300] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:07:43.300] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:27:0) after 1m0s
[19:08:43.323] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:27:0)
[19:08:43.323] Timer tick, asking Buildbucket for the build status
[19:08:43.441] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:08:43.441] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:28:0) after 1m0s
[19:09:43.549] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:28:0)
[19:09:43.549] Timer tick, asking Buildbucket for the build status
[19:09:43.609] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:09:43.609] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:29:0) after 1m0s
[19:10:43.672] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:29:0)
[19:10:43.672] Timer tick, asking Buildbucket for the build status
[19:10:43.951] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:10:43.952] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:30:0) after 1m0s
[19:11:44.136] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:30:0)
[19:11:44.136] Timer tick, asking Buildbucket for the build status
[19:11:44.282] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:11:44.282] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:31:0) after 1m0s
[19:12:44.425] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:31:0)
[19:12:44.425] Timer tick, asking Buildbucket for the build status
[19:12:44.656] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:12:44.656] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:32:0) after 1m0s
[19:13:44.675] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:32:0)
[19:13:44.675] Timer tick, asking Buildbucket for the build status
[19:13:44.819] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:13:44.819] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:33:0) after 1m0s
[19:14:44.953] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:33:0)
[19:14:44.953] Timer tick, asking Buildbucket for the build status
[19:14:45.023] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:14:45.023] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:34:0) after 1m0s
[19:15:45.150] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:34:0)
[19:15:45.150] Timer tick, asking Buildbucket for the build status
[19:15:45.517] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:15:45.517] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:35:0) after 1m0s
[19:16:45.558] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:35:0)
[19:16:45.558] Timer tick, asking Buildbucket for the build status
[19:16:45.783] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:16:45.783] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:36:0) after 1m0s
[19:17:46.386] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:36:0)
[19:17:46.386] Timer tick, asking Buildbucket for the build status
[19:17:46.473] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:17:46.473] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:37:0) after 1m0s
[19:18:46.764] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:37:0)
[19:18:46.764] Timer tick, asking Buildbucket for the build status
[19:18:46.884] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:18:46.884] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:38:0) after 1m0s
[19:19:47.162] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:38:0)
[19:19:47.162] Timer tick, asking Buildbucket for the build status
[19:19:47.339] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:19:47.339] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:39:0) after 1m0s
[19:20:47.430] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:39:0)
[19:20:47.430] Timer tick, asking Buildbucket for the build status
[19:20:47.500] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:20:47.500] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:40:0) after 1m0s
[19:21:47.501] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:40:0)
[19:21:47.501] Timer tick, asking Buildbucket for the build status
[19:21:47.738] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:21:47.738] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:41:0) after 1m0s
[19:22:47.836] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:41:0)
[19:22:47.836] Timer tick, asking Buildbucket for the build status
[19:22:47.939] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:22:47.939] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:42:0) after 1m0s
[19:23:48.156] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:42:0)
[19:23:48.156] Timer tick, asking Buildbucket for the build status
[19:23:48.387] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:23:48.387] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:43:0) after 1m0s
[19:24:48.474] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:43:0)
[19:24:48.474] Timer tick, asking Buildbucket for the build status
[19:24:48.688] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:24:48.688] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:44:0) after 1m0s
[19:25:49.336] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:44:0)
[19:25:49.336] Timer tick, asking Buildbucket for the build status
[19:25:49.569] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:25:49.569] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:45:0) after 1m0s
[19:26:49.775] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:45:0)
[19:26:49.775] Timer tick, asking Buildbucket for the build status
[19:26:50.242] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:26:50.242] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:46:0) after 1m0s
[19:27:50.294] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:46:0)
[19:27:50.294] Timer tick, asking Buildbucket for the build status
[19:27:50.369] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:27:50.369] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:47:0) after 1m0s
[19:28:50.463] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:47:0)
[19:28:50.463] Timer tick, asking Buildbucket for the build status
[19:28:50.572] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:28:50.572] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:48:0) after 1m0s
[19:29:50.893] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:48:0)
[19:29:50.893] Timer tick, asking Buildbucket for the build status
[19:29:51.306] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:29:51.306] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:49:0) after 1m0s
[19:30:51.398] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:49:0)
[19:30:51.398] Timer tick, asking Buildbucket for the build status
[19:30:51.472] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:30:51.472] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:50:0) after 1m0s
[19:31:51.613] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:50:0)
[19:31:51.613] Timer tick, asking Buildbucket for the build status
[19:31:51.699] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:31:51.699] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:51:0) after 1m0s
[19:32:51.886] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:51:0)
[19:32:51.886] Timer tick, asking Buildbucket for the build status
[19:32:51.966] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:32:51.966] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:52:0) after 1m0s
[19:33:52.354] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:52:0)
[19:33:52.354] Timer tick, asking Buildbucket for the build status
[19:33:52.679] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:33:52.679] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:53:0) after 1m0s
[19:34:52.771] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:53:0)
[19:34:52.771] Timer tick, asking Buildbucket for the build status
[19:34:53.012] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:34:53.012] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:54:0) after 1m0s
[19:35:53.367] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:54:0)
[19:35:53.367] Timer tick, asking Buildbucket for the build status
[19:35:53.460] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:35:53.460] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:55:0) after 1m0s
[19:36:53.591] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:55:0)
[19:36:53.591] Timer tick, asking Buildbucket for the build status
[19:36:53.747] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:36:53.747] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:56:0) after 1m0s
[19:37:53.913] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:56:0)
[19:37:53.913] Timer tick, asking Buildbucket for the build status
[19:37:54.042] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:37:54.042] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:57:0) after 1m0s
[19:38:54.177] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:57:0)
[19:38:54.177] Timer tick, asking Buildbucket for the build status
[19:38:54.323] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:38:54.323] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:58:0) after 1m0s
[19:39:54.753] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:58:0)
[19:39:54.753] Timer tick, asking Buildbucket for the build status
[19:39:54.830] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:39:54.830] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:59:0) after 1m0s
[19:40:55.051] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:59:0)
[19:40:55.051] Timer tick, asking Buildbucket for the build status
[19:40:55.277] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:40:55.277] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:60:0) after 1m0s
[19:41:55.380] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:60:0)
[19:41:55.380] Timer tick, asking Buildbucket for the build status
[19:41:55.444] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:41:55.444] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:61:0) after 1m0s
[19:42:55.516] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:61:0)
[19:42:55.516] Timer tick, asking Buildbucket for the build status
[19:42:55.676] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:42:55.676] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:62:0) after 1m0s
[19:43:55.764] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:62:0)
[19:43:55.764] Timer tick, asking Buildbucket for the build status
[19:43:55.911] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:43:55.911] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:63:0) after 1m0s
[19:44:56.151] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:63:0)
[19:44:56.151] Timer tick, asking Buildbucket for the build status
[19:44:56.302] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:44:56.302] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:64:0) after 1m0s
[19:45:56.429] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:64:0)
[19:45:56.429] Timer tick, asking Buildbucket for the build status
[19:45:56.644] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:45:56.644] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:65:0) after 1m0s
[19:46:56.703] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:65:0)
[19:46:56.703] Timer tick, asking Buildbucket for the build status
[19:46:57.140] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:46:57.140] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:66:0) after 1m0s
[19:47:57.385] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:66:0)
[19:47:57.385] Timer tick, asking Buildbucket for the build status
[19:47:58.204] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:47:58.204] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:67:0) after 1m0s
[19:48:58.369] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:67:0)
[19:48:58.369] Timer tick, asking Buildbucket for the build status
[19:48:58.826] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:48:58.826] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:68:0) after 1m0s
[19:49:58.923] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:68:0)
[19:49:58.923] Timer tick, asking Buildbucket for the build status
[19:49:59.045] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:49:59.045] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:69:0) after 1m0s
[19:50:59.118] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:69:0)
[19:50:59.118] Timer tick, asking Buildbucket for the build status
[19:50:59.232] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:50:59.232] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:70:0) after 1m0s
[19:51:59.361] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:70:0)
[19:51:59.361] Timer tick, asking Buildbucket for the build status
[19:51:59.522] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:51:59.522] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:71:0) after 1m0s
[19:52:59.609] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:71:0)
[19:52:59.609] Timer tick, asking Buildbucket for the build status
[19:52:59.774] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:52:59.774] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:72:0) after 1m0s
[19:53:59.826] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:72:0)
[19:53:59.826] Timer tick, asking Buildbucket for the build status
[19:54:00.781] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:54:00.781] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:73:0) after 1m0s
[19:55:01.127] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:73:0)
[19:55:01.127] Timer tick, asking Buildbucket for the build status
[19:55:01.302] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:55:01.302] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:74:0) after 1m0s
[19:56:02.584] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:74:0)
[19:56:02.584] Timer tick, asking Buildbucket for the build status
[19:56:02.717] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:56:02.717] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:75:0) after 1m0s
[19:57:02.811] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:75:0)
[19:57:02.811] Timer tick, asking Buildbucket for the build status
[19:57:03.136] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:57:03.136] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:76:0) after 1m0s
[19:58:03.126] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:76:0)
[19:58:03.126] Timer tick, asking Buildbucket for the build status
[19:58:03.425] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:58:03.425] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:77:0) after 1m0s
[19:59:03.459] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:77:0)
[19:59:03.459] Timer tick, asking Buildbucket for the build status
[19:59:03.622] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:59:03.622] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:78:0) after 1m0s
[20:00:03.692] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:78:0)
[20:00:03.692] Timer tick, asking Buildbucket for the build status
[20:00:04.522] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:00:04.522] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:79:0) after 1m0s
[20:01:04.587] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:79:0)
[20:01:04.587] Timer tick, asking Buildbucket for the build status
[20:01:04.903] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:01:04.903] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:80:0) after 1m0s
[20:02:05.004] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:80:0)
[20:02:05.004] Timer tick, asking Buildbucket for the build status
[20:02:05.146] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:02:05.146] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:81:0) after 1m0s
[20:03:05.187] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:81:0)
[20:03:05.187] Timer tick, asking Buildbucket for the build status
[20:03:05.309] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:03:05.309] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:82:0) after 1m0s
[20:04:05.429] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:82:0)
[20:04:05.429] Timer tick, asking Buildbucket for the build status
[20:04:05.638] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:04:05.638] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:83:0) after 1m0s
[20:05:05.682] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:83:0)
[20:05:05.682] Timer tick, asking Buildbucket for the build status
[20:05:05.846] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:05:05.846] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:84:0) after 1m0s
[20:06:05.896] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:84:0)
[20:06:05.896] Timer tick, asking Buildbucket for the build status
[20:06:06.305] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:06:06.305] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:85:0) after 1m0s
[20:07:06.355] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:85:0)
[20:07:06.355] Timer tick, asking Buildbucket for the build status
[20:07:06.602] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:07:06.602] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:86:0) after 1m0s
[20:08:06.629] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:86:0)
[20:08:06.629] Timer tick, asking Buildbucket for the build status
[20:08:06.774] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:08:06.774] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:87:0) after 1m0s
[20:09:06.820] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:87:0)
[20:09:06.820] Timer tick, asking Buildbucket for the build status
[20:09:06.960] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:09:06.960] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:88:0) after 1m0s
[20:10:07.055] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:88:0)
[20:10:07.055] Timer tick, asking Buildbucket for the build status
[20:10:07.495] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:10:07.495] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:89:0) after 1m0s
[20:11:07.545] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:89:0)
[20:11:07.545] Timer tick, asking Buildbucket for the build status
[20:11:07.638] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:11:07.638] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:90:0) after 1m0s
[20:12:07.663] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:90:0)
[20:12:07.663] Timer tick, asking Buildbucket for the build status
[20:12:08.089] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:12:08.089] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:91:0) after 1m0s
[20:13:08.185] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:91:0)
[20:13:08.185] Timer tick, asking Buildbucket for the build status
[20:13:08.268] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:13:08.268] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:92:0) after 1m0s
[20:14:08.585] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:92:0)
[20:14:08.585] Timer tick, asking Buildbucket for the build status
[20:14:08.814] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:14:08.814] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:93:0) after 1m0s
[20:15:08.842] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:93:0)
[20:15:08.842] Timer tick, asking Buildbucket for the build status
[20:15:08.914] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:15:08.914] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:94:0) after 1m0s
[20:16:09.149] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:94:0)
[20:16:09.149] Timer tick, asking Buildbucket for the build status
[20:16:09.232] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:16:09.232] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:95:0) after 1m0s
[20:17:09.397] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:95:0)
[20:17:09.397] Timer tick, asking Buildbucket for the build status
[20:17:10.287] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:17:10.287] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:96:0) after 1m0s
[20:18:10.422] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:96:0)
[20:18:10.422] Timer tick, asking Buildbucket for the build status
[20:18:10.562] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:18:10.562] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:97:0) after 1m0s
[20:19:10.672] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:97:0)
[20:19:10.672] Timer tick, asking Buildbucket for the build status
[20:19:10.872] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:19:10.872] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:98:0) after 1m0s
[20:20:10.849] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:98:0)
[20:20:10.849] Timer tick, asking Buildbucket for the build status
[20:20:10.933] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:20:10.933] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:99:0) after 1m0s
[20:21:10.968] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:99:0)
[20:21:10.968] Timer tick, asking Buildbucket for the build status
[20:21:11.060] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:21:11.060] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:100:0) after 1m0s
[20:22:11.063] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:100:0)
[20:22:11.063] Timer tick, asking Buildbucket for the build status
[20:22:12.110] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:22:12.110] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:101:0) after 1m0s
[20:23:12.273] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:101:0)
[20:23:12.273] Timer tick, asking Buildbucket for the build status
[20:23:12.403] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:23:12.403] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:102:0) after 1m0s
[20:24:12.431] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:102:0)
[20:24:12.431] Timer tick, asking Buildbucket for the build status
[20:24:13.502] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:24:13.502] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:103:0) after 1m0s
[20:25:13.636] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:103:0)
[20:25:13.636] Timer tick, asking Buildbucket for the build status
[20:25:14.171] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:25:14.171] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:104:0) after 1m0s
[20:26:14.198] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:104:0)
[20:26:14.198] Timer tick, asking Buildbucket for the build status
[20:26:14.270] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:26:14.270] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:105:0) after 1m0s
[20:27:14.397] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:105:0)
[20:27:14.397] Timer tick, asking Buildbucket for the build status
[20:27:14.555] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:27:14.555] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:106:0) after 1m0s
[20:28:14.613] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:106:0)
[20:28:14.613] Timer tick, asking Buildbucket for the build status
[20:28:16.358] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:28:16.358] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:107:0) after 1m0s
[20:29:16.442] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:107:0)
[20:29:16.442] Timer tick, asking Buildbucket for the build status
[20:29:16.575] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:29:16.575] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:108:0) after 1m0s
[20:30:16.592] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:108:0)
[20:30:16.592] Timer tick, asking Buildbucket for the build status
[20:30:16.684] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:30:16.684] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:109:0) after 1m0s
[20:31:16.732] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:109:0)
[20:31:16.732] Timer tick, asking Buildbucket for the build status
[20:31:16.828] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:31:16.828] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:110:0) after 1m0s
[20:32:16.985] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:110:0)
[20:32:16.985] Timer tick, asking Buildbucket for the build status
[20:32:17.464] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:32:17.464] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:111:0) after 1m0s
[20:33:17.513] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:111:0)
[20:33:17.513] Timer tick, asking Buildbucket for the build status
[20:33:17.696] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:33:17.697] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:112:0) after 1m0s
[20:34:17.752] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:112:0)
[20:34:17.752] Timer tick, asking Buildbucket for the build status
[20:34:17.910] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:34:17.910] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:113:0) after 1m0s
[20:35:17.961] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:113:0)
[20:35:17.961] Timer tick, asking Buildbucket for the build status
[20:35:18.159] Build 8865262137429638624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:35:18.159] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9030692199419271056:114:0) after 1m0s
[20:35:44.831] Received PubSub notification, asking Buildbucket for the build status
[20:35:44.931] Build 8865262137429638624: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[20:35:44.931] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1603830942756069",
"created_by": "project:chromium",
"created_ts": "1603824213532121",
"id": "8865262137429638624",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"d943b2e67ee2494c269149a9cd78b122823f535d\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"enable_ats\": true, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$recipe_engine/milo/blamelist_pins\": [{\"host\": \"chromium.googlesource.com\", \"id\": \"d943b2e67ee2494c269149a9cd78b122823f535d\", \"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-east1-d-8-33-tkqx\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-dbg\", \"buildnumber\": 21033, \"got_angle_revision\": \"b5ba693316fdd5e680f2bb4cf1a2f9bed589d8e2\", \"got_dawn_revision\": \"25eeaa3d39afcc82fe9d384949d4e9c99e6e7903\", \"got_nacl_revision\": \"0fabd6dc4222dfae664e55a84326e0c904f5b62c\", \"got_revision\": \"d943b2e67ee2494c269149a9cd78b122823f535d\", \"got_revision_cp\": \"refs/heads/master@{#821360}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"df17a76102dfabb3f1bd6e51449cece9f77b45e3\", \"got_v8_revision\": \"20aa521f10950ef2db0f60fc487e68d9fa14d703\", \"got_v8_revision_cp\": \"refs/heads/8.8.190@{#1}\", \"got_webrtc_revision\": \"0fb0eb3e80c09e0483c4dccdaa472e7e81f182fe\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32491}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"d943b2e67ee2494c269149a9cd78b122823f535d\", \"swarm_hashes_refs/heads/master(at){#821360}_without_patch\": {\"absl_hardening_tests\": \"6e725c64a9de8afe8f4a8ea8d344cc81a0b8af0d\", \"accessibility_unittests\": \"04b9d6e6aa5cc1e7ec9318913ef5b4621a2f5a35\", \"angle_unittests\": \"13e576cc7aee8cb07d56fd06ec3eace529f8dbaa\", \"app_list_unittests\": \"d3a9de46dd52bac68c9efc2a9009c7a19a05b0c8\", \"app_shell_unittests\": \"8557d6d9e27115caec1ed65281a3813f44b97343\", \"ash_unittests\": \"89efdb822772c5fad4fd2eebbb2621478988a555\", \"aura_unittests\": \"68222f06113c01a125d4b0230e655f7504e37930\", \"base_unittests\": \"e08866933ea010a3e4d8a2dedcc772cde7730b64\", \"base_util_unittests\": \"88b075acc30832bfa318da58cdb4f94a12f031be\", \"blink_common_unittests\": \"ed9f509a4f0bda61ff396b790a234981175f9a4e\", \"blink_fuzzer_unittests\": \"058b005d83672c422c124f98b7f5d04adfb36ec0\", \"blink_heap_unittests\": \"72e371d3a23c3314e4d887b0ca77ee60d77a3237\", \"blink_platform_unittests\": \"cfcf61b5ce10895f0e6fb41c81d486f0cfd32ded\", \"blink_unittests\": \"74932b57ebfbae4c087f215bd004ef966f22b903\", \"boringssl_crypto_tests\": \"df99001f891c6455ccb365ce380e22dd304c5683\", \"boringssl_ssl_tests\": \"1104e2f5995bbc552e102ba035831fa798c507cf\", \"browser_tests\": \"d341cc849d6b6bb95cc114317c29383461af97fb\", \"capture_unittests\": \"ef044b6c49322f79729323d2966a95f984b4e353\", \"cast_unittests\": \"c067fdc2a2b03db2c92b88de2cb5a8a8a8b7def8\", \"cc_unittests\": \"171e9f5566410f9862432f5a93e4fce7008862c2\", \"chrome_app_unittests\": \"627b00a8da3d800ed2803de57a8bb6f6dc161691\", \"chromedriver_unittests\": \"1ab4cfe9aed23c2dff6f2caf9eb65f496d096a23\", \"chromeos_components_unittests\": \"d81013b37a7a1eae7c32c21a72ad0f1bf20181d5\", \"chromeos_unittests\": \"0664e61e5216ecc08fd01752b0e28c655df076c9\", \"components_browsertests\": \"0c40ba446d54ad41a4b3abbf553b6461961c21a9\", \"components_unittests\": \"fdd5215eb732540b947da1f60e6060d5b1b85c55\", \"compositor_unittests\": \"f9212638b71ce05b1100bd8f5d185e2c7df4adf8\", \"content_browsertests\": \"557721f78cf6929607f531135c0a4f0ab9791a4c\", \"content_unittests\": \"9fc8aeb63ba6f0c6a1630e943af13126f6cda5e7\", \"crypto_unittests\": \"9c1b8b796ddac635e804927e1fa8e4c378d2329b\", \"dbus_unittests\": \"352cfd2cfa61ebcbc2484ba85ce666f064225d4a\", \"device_unittests\": \"dad09d5283928b3301bb8a0b875307e86483e856\", \"display_unittests\": \"2884b1b5b7e19ff62d79b0e32629c52aff26e8da\", \"events_unittests\": \"a343ee56d070d6faad526f69505524031ab92dcf\", \"exo_unittests\": \"492b6a9a8a405b2bf2b13f3f9e0496d629c89212\", \"extensions_browsertests\": \"ccc7ef54bbc5adc7f7c9b16e1d1256a29023b7c2\", \"extensions_unittests\": \"e4e42836223743629b732324ed60763c141c6259\", \"filesystem_service_unittests\": \"abbab3c41a52d8b1b9ac8cf6738dca680aa9b874\", \"gcm_unit_tests\": \"5898881496b230ab9016f3a9e2a0e6bd95a08de0\", \"gfx_unittests\": \"748d19de7116853acc30330442d4a4abaa7a6184\", \"gin_unittests\": \"931ceb4431aed27b14f0be6475637f6a8e92f734\", \"gl_unittests_ozone\": \"002303b90c4ceffee3c54195d46ac06cbaa9214c\", \"google_apis_unittests\": \"99d7135f4773b13cdff5620ccb01c170a1260f20\", \"gpu_unittests\": \"0960822a4506da61559a15b69e8b4e6d0e4ce39c\", \"gwp_asan_unittests\": \"323b2d6a131e856742d686b07efa3f490fc91bfe\", \"interactive_ui_tests\": \"16206c25ef7881a56a98c38bb1e41996e3c462fd\", \"ipc_tests\": \"ad557c26bbac668443c89542d4b8edd96306f2b6\", \"jingle_unittests\": \"6df6a4802cdd00e37d0d27e31c18bf0827245d87\", \"keyboard_unittests\": \"6fb04e34c89ca84f083d2daa5580bcbdf34ff783\", \"latency_unittests\": \"5e2c6373b4aabdbb15c30b2ca0fabd338afef9fa\", \"libjingle_xmpp_unittests\": \"ecdb6746c94e9e2c6f9a7a07537495196eeddf13\", \"media_blink_unittests\": \"12d12946e0d717dc6286011509dfe96f7c476999\", \"media_unittests\": \"ad5199667f7ac11d1470e400034dd85141378ae6\", \"message_center_unittests\": \"f36083383ffeee0c1b169215eec9b98260fe8c50\", \"midi_unittests\": \"2e7de791a278131c90600af96134ee445827fe22\", \"mojo_core_unittests\": \"4d370063a861285381f8a6f772614c91cb66a323\", \"mojo_unittests\": \"bdb4767db7e65818eb6c0fa6b84900e4f62a84d2\", \"nacl_helper_nonsfi_unittests\": \"f2b47376f0ad3a50e509def04f86867e7cf1b5d9\", \"nacl_loader_unittests\": \"474f3ebce235b1f5a73ca6bee9908135f63a8160\", \"native_theme_unittests\": \"c174ef538b62ab48c288df076eb2f8ed0d518623\", \"net_unittests\": \"0fff73437b59f8dd4e84e865ae8325f89bf5ec30\", \"ozone_gl_unittests\": \"8a2d62df6650ca201049403a2878c06b3c96c2f3\", \"ozone_unittests\": \"c8d7061f1404c708e752c886a2cd3838afe0d9b6\", \"ozone_x11_unittests\": \"e665d1bbc50ae8c734d82751b7691df445d4b454\", \"pdf_unittests\": \"ed3fcf445a82e951db11fa2eb78fa3be8bf10044\", \"perfetto_unittests\": \"7b7eec6097cb4c9d47ad7d578c6eb20c9e0d0110\", \"ppapi_unittests\": \"ede86d4ba2a59d29226c2d1edb190bf69f0928fa\", \"printing_unittests\": \"d7bbc6fe606d2359a33710412a6dfbdbb1a998fe\", \"remoting_unittests\": \"0338f87aab4ec4cc36f9e249827fc69cd352e250\", \"sandbox_linux_unittests\": \"0c29e7b1acc0e249c7c4ae899f4f4ab7f68c782b\", \"service_manager_unittests\": \"801e72507737763c5a497d7c4ab55ad253f84107\", \"services_unittests\": \"afa492c6f82bdadfd628fbc78cd318b76c096894\", \"shell_dialogs_unittests\": \"45f978dd76b580b9c6d048331c64f27585375b1f\", \"skia_unittests\": \"6fb064fc085674bf49e8e53314d3db8ee93afb74\", \"snapshot_unittests\": \"8b3851f68d0244d872570b95c7e7e34aee951335\", \"sql_unittests\": \"c8deff84e37bd2e37b637ea4f3800a8bc5dda0ab\", \"storage_unittests\": \"07714558ba356d9fc0f9916d47301c1ce89e83d4\", \"sync_integration_tests\": \"5f0e74402bd5818a72b9e5f4a0a1480b8946ca51\", \"traffic_annotation_auditor_unittests\": \"b759ea3a900a749ff287e895ca95ab67bc444fa3\", \"ui_base_unittests\": \"504d99db0cbd18ae0b6a246511469044665c1b83\", \"ui_chromeos_unittests\": \"1138e4e50875d64970807b15c8365d91ad269982\", \"ui_touch_selection_unittests\": \"8c7619e2e552fd20560158f6a9df262459492217\", \"unit_tests\": \"5bccb83281a4877b663dc38f6ecc14b7ac1b37f7\", \"url_unittests\": \"2f2019958dee6ff64ccce43eb2943440f25e06b5\", \"usage_time_limit_unittests\": \"307f7910578cbd3724ddbfbe6135346ae9442c7a\", \"views_unittests\": \"54fcd470980952d4016a9c8012372c2fd37d258a\", \"viz_unittests\": \"db620f43e93e2609528a9684a8739518914bbdd1\", \"wm_unittests\": \"866cb1b4aa7a9a36b88207297d53b372d315e457\", \"wtf_unittests\": \"6e16fc31e379283ec863cbc2be1ee9c0b247af65\", \"zlib_unittests\": \"9beaa526109dee6070a61d5fafaa0f1fe5012adb\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_08506e22a0e0fdc29bd318165699b599f0671cf91287ea7a96642b02d7ff24e4_v2\", \"builder_4973d939604d11dcbaec68575e69c80c756ff63e355ab013b29b8bca26434b7c_v2\", \"builder_5315cf154f9c1ae6b2621094599bc107171a849e1c0f232ec66a504ee800a364_v2\", \"builder_78c5fa2a76d0a7a104d66f8a40d0b5b0500192b052ec21dd345993f3fb5ca43a_v2\", \"builder_8e7ad9a10a7772feba5b42dda56992e918fe88f23579c3ddaf696dde66ee4238_v2\", \"builder_c9091f6bc58db7983401393b6dacc93b3db8fae2c2ae9b40177b9e0904c8bc80_v2\", \"builder_dd549fc6a716e6a939fbd3a419c5738d31929c905615e3b6decc21ab2a48e41b_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-east1-d-8-33-tkqx\"], \"image\": [\"chrome-xenial-20101800-2d400e1627f\"], \"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\": [\"5613-2fddb4d\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-d\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1603824216474108",
"status": "COMPLETED",
"status_changed_ts": "1603830943389458",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/21033",
"builder:linux-chromeos-dbg",
"buildset:commit/git/d943b2e67ee2494c269149a9cd78b122823f535d",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/d943b2e67ee2494c269149a9cd78b122823f535d",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9030692199419271056",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8865262137429638624/+/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:4f8430e919bfea10",
"user_agent:luci-scheduler"
],
"updated_ts": "1603830943478430",
"url": "https://ci.chromium.org/b/8865262137429638624",
"utcnow_ts": "1603830944920029"
}
}
[20:35:44.931] Invocation finished in 1h52m12.679589288s with status SUCCEEDED