[02:38:44.323] New invocation is queued and will start shortly
[02:38:45.381] Starting the invocation (attempt 1)
[02:38:45.414] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[02:38:45.415] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[02:38:45.415] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9019337681561022272",
"parameters_json": "{\"builder_name\":\"linux-chromeos-dbg\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"a7beda00182b1ad40d248eaa0dc0986d03073672\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:linux-chromeos-dbg",
"scheduler_invocation_id:9019337681561022272",
"scheduler_job_id:chromium/linux-chromeos-dbg",
"user_agent:luci-scheduler",
"buildset:commit/git/a7beda00182b1ad40d248eaa0dc0986d03073672",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/a7beda00182b1ad40d248eaa0dc0986d03073672",
"gitiles_ref:refs/heads/master"
]
}
[02:38:46.042] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"created_by": "project:chromium",
"created_ts": "1614652725493516",
"id": "8853907619671859648",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"a7beda00182b1ad40d248eaa0dc0986d03073672\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1614652725852619",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/22825",
"builder:linux-chromeos-dbg",
"buildset:commit/git/a7beda00182b1ad40d248eaa0dc0986d03073672",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/a7beda00182b1ad40d248eaa0dc0986d03073672",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019337681561022272",
"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/8853907619671859648/+/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": "1614652725852746",
"url": "https://ci.chromium.org/b/8853907619671859648",
"utcnow_ts": "1614652726035449"
}
}
[02:38:46.042] Task URL: https://ci.chromium.org/b/8853907619671859648
[02:38:46.043] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:2:0) after 1m0s
[02:38:47.967] Received PubSub notification, asking Buildbucket for the build status
[02:38:48.028] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:39:46.290] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:2:0)
[02:39:46.290] Timer tick, asking Buildbucket for the build status
[02:39:46.540] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:39:46.540] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:4:0) after 1m0s
[02:40:46.648] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:4:0)
[02:40:46.648] Timer tick, asking Buildbucket for the build status
[02:40:46.722] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:40:46.722] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:5:0) after 1m0s
[02:41:46.719] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:5:0)
[02:41:46.719] Timer tick, asking Buildbucket for the build status
[02:41:47.129] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:41:47.129] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:6:0) after 1m0s
[02:42:47.983] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:6:0)
[02:42:47.983] Timer tick, asking Buildbucket for the build status
[02:42:48.056] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:42:48.056] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:7:0) after 1m0s
[02:43:48.461] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:7:0)
[02:43:48.461] Timer tick, asking Buildbucket for the build status
[02:43:48.638] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:43:48.638] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:8:0) after 1m0s
[02:44:48.843] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:8:0)
[02:44:48.843] Timer tick, asking Buildbucket for the build status
[02:44:48.991] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:44:48.991] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:9:0) after 1m0s
[02:45:49.157] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:9:0)
[02:45:49.157] Timer tick, asking Buildbucket for the build status
[02:45:49.237] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:45:49.237] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:10:0) after 1m0s
[02:46:49.316] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:10:0)
[02:46:49.316] Timer tick, asking Buildbucket for the build status
[02:46:50.557] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:46:50.557] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:11:0) after 1m0s
[02:47:50.802] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:11:0)
[02:47:50.802] Timer tick, asking Buildbucket for the build status
[02:47:50.886] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:47:50.886] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:12:0) after 1m0s
[02:48:50.967] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:12:0)
[02:48:50.967] Timer tick, asking Buildbucket for the build status
[02:48:51.049] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:48:51.049] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:13:0) after 1m0s
[02:49:51.091] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:13:0)
[02:49:51.091] Timer tick, asking Buildbucket for the build status
[02:49:51.259] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:49:51.259] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:14:0) after 1m0s
[02:50:51.247] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:14:0)
[02:50:51.247] Timer tick, asking Buildbucket for the build status
[02:50:51.309] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:50:51.309] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:15:0) after 1m0s
[02:51:51.329] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:15:0)
[02:51:51.329] Timer tick, asking Buildbucket for the build status
[02:51:51.402] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:51:51.402] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:16:0) after 1m0s
[02:52:51.447] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:16:0)
[02:52:51.447] Timer tick, asking Buildbucket for the build status
[02:52:51.540] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:52:51.540] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:17:0) after 1m0s
[02:53:51.603] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:17:0)
[02:53:51.603] Timer tick, asking Buildbucket for the build status
[02:53:51.922] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:53:51.922] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:18:0) after 1m0s
[02:54:51.957] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:18:0)
[02:54:51.957] Timer tick, asking Buildbucket for the build status
[02:54:52.048] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:54:52.048] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:19:0) after 1m0s
[02:55:52.115] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:19:0)
[02:55:52.115] Timer tick, asking Buildbucket for the build status
[02:55:52.180] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:55:52.180] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:20:0) after 1m0s
[02:56:52.260] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:20:0)
[02:56:52.260] Timer tick, asking Buildbucket for the build status
[02:56:52.361] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:56:52.361] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:21:0) after 1m0s
[02:57:52.404] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:21:0)
[02:57:52.404] Timer tick, asking Buildbucket for the build status
[02:57:53.094] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:57:53.094] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:22:0) after 1m0s
[02:58:53.138] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:22:0)
[02:58:53.138] Timer tick, asking Buildbucket for the build status
[02:58:53.218] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:58:53.218] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:23:0) after 1m0s
[02:59:53.312] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:23:0)
[02:59:53.312] Timer tick, asking Buildbucket for the build status
[02:59:53.411] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:59:53.411] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:24:0) after 1m0s
[03:00:53.495] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:24:0)
[03:00:53.495] Timer tick, asking Buildbucket for the build status
[03:00:53.843] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:00:53.843] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:25:0) after 1m0s
[03:01:53.926] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:25:0)
[03:01:53.926] Timer tick, asking Buildbucket for the build status
[03:01:54.214] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:01:54.214] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:26:0) after 1m0s
[03:02:54.251] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:26:0)
[03:02:54.251] Timer tick, asking Buildbucket for the build status
[03:02:55.666] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:02:55.666] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:27:0) after 1m0s
[03:03:56.225] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:27:0)
[03:03:56.225] Timer tick, asking Buildbucket for the build status
[03:03:56.748] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:03:56.748] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:28:0) after 1m0s
[03:04:56.905] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:28:0)
[03:04:56.905] Timer tick, asking Buildbucket for the build status
[03:04:56.979] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:04:56.979] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:29:0) after 1m0s
[03:05:57.061] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:29:0)
[03:05:57.061] Timer tick, asking Buildbucket for the build status
[03:05:57.142] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:05:57.142] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:30:0) after 1m0s
[03:06:57.279] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:30:0)
[03:06:57.279] Timer tick, asking Buildbucket for the build status
[03:06:57.350] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:06:57.350] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:31:0) after 1m0s
[03:07:57.436] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:31:0)
[03:07:57.436] Timer tick, asking Buildbucket for the build status
[03:07:57.503] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:07:57.503] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:32:0) after 1m0s
[03:08:57.631] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:32:0)
[03:08:57.631] Timer tick, asking Buildbucket for the build status
[03:08:57.701] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:08:57.701] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:33:0) after 1m0s
[03:09:57.743] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:33:0)
[03:09:57.743] Timer tick, asking Buildbucket for the build status
[03:09:57.826] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:09:57.826] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:34:0) after 1m0s
[03:10:57.895] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:34:0)
[03:10:57.895] Timer tick, asking Buildbucket for the build status
[03:10:57.978] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:10:57.978] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:35:0) after 1m0s
[03:11:59.146] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:35:0)
[03:11:59.146] Timer tick, asking Buildbucket for the build status
[03:11:59.214] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:11:59.214] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:36:0) after 1m0s
[03:12:59.370] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:36:0)
[03:12:59.370] Timer tick, asking Buildbucket for the build status
[03:12:59.512] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:12:59.512] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:37:0) after 1m0s
[03:13:59.666] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:37:0)
[03:13:59.666] Timer tick, asking Buildbucket for the build status
[03:13:59.733] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:13:59.733] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:38:0) after 1m0s
[03:14:59.776] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:38:0)
[03:14:59.776] Timer tick, asking Buildbucket for the build status
[03:14:59.882] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:14:59.882] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:39:0) after 1m0s
[03:15:59.951] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:39:0)
[03:15:59.951] Timer tick, asking Buildbucket for the build status
[03:16:00.079] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:16:00.079] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:40:0) after 1m0s
[03:17:00.227] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:40:0)
[03:17:00.227] Timer tick, asking Buildbucket for the build status
[03:17:00.315] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:17:00.315] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:41:0) after 1m0s
[03:18:00.476] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:41:0)
[03:18:00.476] Timer tick, asking Buildbucket for the build status
[03:18:00.587] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:18:00.587] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:42:0) after 1m0s
[03:19:01.250] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:42:0)
[03:19:01.250] Timer tick, asking Buildbucket for the build status
[03:19:02.008] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:19:02.008] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:43:0) after 1m0s
[03:20:03.045] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:43:0)
[03:20:03.045] Timer tick, asking Buildbucket for the build status
[03:20:03.143] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:20:03.143] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:44:0) after 1m0s
[03:21:03.719] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:44:0)
[03:21:03.719] Timer tick, asking Buildbucket for the build status
[03:21:03.834] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:21:03.834] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:45:0) after 1m0s
[03:22:04.011] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:45:0)
[03:22:04.011] Timer tick, asking Buildbucket for the build status
[03:22:04.169] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:22:04.169] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:46:0) after 1m0s
[03:23:04.345] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:46:0)
[03:23:04.346] Timer tick, asking Buildbucket for the build status
[03:23:04.434] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:23:04.434] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:47:0) after 1m0s
[03:24:04.647] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:47:0)
[03:24:04.647] Timer tick, asking Buildbucket for the build status
[03:24:04.770] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:24:04.770] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:48:0) after 1m0s
[03:25:04.853] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:48:0)
[03:25:04.853] Timer tick, asking Buildbucket for the build status
[03:25:04.966] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:25:04.966] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:49:0) after 1m0s
[03:26:05.375] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:49:0)
[03:26:05.375] Timer tick, asking Buildbucket for the build status
[03:26:05.532] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:26:05.532] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:50:0) after 1m0s
[03:27:05.871] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:50:0)
[03:27:05.871] Timer tick, asking Buildbucket for the build status
[03:27:05.942] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:27:05.942] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:51:0) after 1m0s
[03:28:06.113] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:51:0)
[03:28:06.113] Timer tick, asking Buildbucket for the build status
[03:28:06.883] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:28:06.883] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:52:0) after 1m0s
[03:29:07.297] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:52:0)
[03:29:07.297] Timer tick, asking Buildbucket for the build status
[03:29:07.461] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:29:07.461] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:53:0) after 1m0s
[03:30:07.598] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:53:0)
[03:30:07.598] Timer tick, asking Buildbucket for the build status
[03:30:07.817] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:30:07.817] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:54:0) after 1m0s
[03:31:07.857] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:54:0)
[03:31:07.857] Timer tick, asking Buildbucket for the build status
[03:31:08.026] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:31:08.026] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:55:0) after 1m0s
[03:32:08.071] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:55:0)
[03:32:08.071] Timer tick, asking Buildbucket for the build status
[03:32:08.161] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:32:08.161] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:56:0) after 1m0s
[03:33:08.188] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:56:0)
[03:33:08.188] Timer tick, asking Buildbucket for the build status
[03:33:08.613] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:33:08.613] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:57:0) after 1m0s
[03:34:08.656] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:57:0)
[03:34:08.656] Timer tick, asking Buildbucket for the build status
[03:34:08.759] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:34:08.759] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:58:0) after 1m0s
[03:35:08.783] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:58:0)
[03:35:08.783] Timer tick, asking Buildbucket for the build status
[03:35:08.885] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:35:08.885] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:59:0) after 1m0s
[03:36:08.909] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:59:0)
[03:36:08.909] Timer tick, asking Buildbucket for the build status
[03:36:09.000] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:36:09.000] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:60:0) after 1m0s
[03:37:09.044] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:60:0)
[03:37:09.044] Timer tick, asking Buildbucket for the build status
[03:37:09.628] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:37:09.628] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:61:0) after 1m0s
[03:38:09.663] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:61:0)
[03:38:09.663] Timer tick, asking Buildbucket for the build status
[03:38:09.739] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:38:09.739] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:62:0) after 1m0s
[03:39:09.799] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:62:0)
[03:39:09.799] Timer tick, asking Buildbucket for the build status
[03:39:09.944] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:39:09.944] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:63:0) after 1m0s
[03:40:09.977] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:63:0)
[03:40:09.977] Timer tick, asking Buildbucket for the build status
[03:40:10.038] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:40:10.038] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:64:0) after 1m0s
[03:41:10.175] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:64:0)
[03:41:10.175] Timer tick, asking Buildbucket for the build status
[03:41:10.254] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:41:10.254] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:65:0) after 1m0s
[03:42:10.322] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:65:0)
[03:42:10.322] Timer tick, asking Buildbucket for the build status
[03:42:10.400] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:42:10.400] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:66:0) after 1m0s
[03:43:10.567] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:66:0)
[03:43:10.567] Timer tick, asking Buildbucket for the build status
[03:43:10.636] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:43:10.636] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:67:0) after 1m0s
[03:44:10.789] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:67:0)
[03:44:10.789] Timer tick, asking Buildbucket for the build status
[03:44:11.042] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:44:11.042] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:68:0) after 1m0s
[03:45:11.288] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:68:0)
[03:45:11.288] Timer tick, asking Buildbucket for the build status
[03:45:11.950] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:45:11.950] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:69:0) after 1m0s
[03:46:12.066] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:69:0)
[03:46:12.066] Timer tick, asking Buildbucket for the build status
[03:46:12.157] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:46:12.157] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:70:0) after 1m0s
[03:47:12.223] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:70:0)
[03:47:12.223] Timer tick, asking Buildbucket for the build status
[03:47:12.363] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:47:12.363] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:71:0) after 1m0s
[03:48:12.499] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:71:0)
[03:48:12.499] Timer tick, asking Buildbucket for the build status
[03:48:12.592] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:48:12.592] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:72:0) after 1m0s
[03:49:12.638] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:72:0)
[03:49:12.638] Timer tick, asking Buildbucket for the build status
[03:49:12.981] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:49:12.981] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:73:0) after 1m0s
[03:50:13.015] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:73:0)
[03:50:13.015] Timer tick, asking Buildbucket for the build status
[03:50:13.307] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:50:13.307] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:74:0) after 1m0s
[03:51:13.394] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:74:0)
[03:51:13.395] Timer tick, asking Buildbucket for the build status
[03:51:13.480] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:51:13.480] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:75:0) after 1m0s
[03:52:13.508] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:75:0)
[03:52:13.508] Timer tick, asking Buildbucket for the build status
[03:52:13.641] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:52:13.641] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:76:0) after 1m0s
[03:53:13.688] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:76:0)
[03:53:13.688] Timer tick, asking Buildbucket for the build status
[03:53:14.434] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:53:14.434] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:77:0) after 1m0s
[03:54:14.622] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:77:0)
[03:54:14.622] Timer tick, asking Buildbucket for the build status
[03:54:14.802] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:54:14.802] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:78:0) after 1m0s
[03:55:14.884] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:78:0)
[03:55:14.884] Timer tick, asking Buildbucket for the build status
[03:55:15.007] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:55:15.007] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:79:0) after 1m0s
[03:56:15.041] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:79:0)
[03:56:15.041] Timer tick, asking Buildbucket for the build status
[03:56:15.305] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:56:15.305] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:80:0) after 1m0s
[03:57:15.370] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:80:0)
[03:57:15.370] Timer tick, asking Buildbucket for the build status
[03:57:15.646] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:57:15.646] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:81:0) after 1m0s
[03:58:15.730] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:81:0)
[03:58:15.730] Timer tick, asking Buildbucket for the build status
[03:58:15.847] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:58:15.847] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:82:0) after 1m0s
[03:59:15.890] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:82:0)
[03:59:15.890] Timer tick, asking Buildbucket for the build status
[03:59:15.966] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[03:59:15.966] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:83:0) after 1m0s
[04:00:16.059] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:83:0)
[04:00:16.059] Timer tick, asking Buildbucket for the build status
[04:00:16.353] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:00:16.353] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:84:0) after 1m0s
[04:01:16.520] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:84:0)
[04:01:16.520] Timer tick, asking Buildbucket for the build status
[04:01:16.647] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:01:16.647] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:85:0) after 1m0s
[04:02:16.750] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:85:0)
[04:02:16.750] Timer tick, asking Buildbucket for the build status
[04:02:17.149] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:02:17.149] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:86:0) after 1m0s
[04:03:17.122] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:86:0)
[04:03:17.122] Timer tick, asking Buildbucket for the build status
[04:03:17.983] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:03:17.983] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:87:0) after 1m0s
[04:04:18.029] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:87:0)
[04:04:18.029] Timer tick, asking Buildbucket for the build status
[04:04:18.876] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:04:18.876] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:88:0) after 1m0s
[04:05:18.952] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:88:0)
[04:05:18.952] Timer tick, asking Buildbucket for the build status
[04:05:19.615] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:05:19.615] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:89:0) after 1m0s
[04:06:19.687] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:89:0)
[04:06:19.687] Timer tick, asking Buildbucket for the build status
[04:06:20.141] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:06:20.141] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:90:0) after 1m0s
[04:07:20.137] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:90:0)
[04:07:20.137] Timer tick, asking Buildbucket for the build status
[04:07:20.379] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:07:20.379] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:91:0) after 1m0s
[04:08:20.387] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:91:0)
[04:08:20.387] Timer tick, asking Buildbucket for the build status
[04:08:21.025] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:08:21.025] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:92:0) after 1m0s
[04:09:21.067] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:92:0)
[04:09:21.067] Timer tick, asking Buildbucket for the build status
[04:09:21.166] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:09:21.166] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:93:0) after 1m0s
[04:10:21.155] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:93:0)
[04:10:21.155] Timer tick, asking Buildbucket for the build status
[04:10:21.343] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:10:21.344] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:94:0) after 1m0s
[04:11:21.580] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:94:0)
[04:11:21.580] Timer tick, asking Buildbucket for the build status
[04:11:22.301] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:11:22.301] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:95:0) after 1m0s
[04:12:22.372] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:95:0)
[04:12:22.372] Timer tick, asking Buildbucket for the build status
[04:12:22.968] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:12:22.968] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:96:0) after 1m0s
[04:13:23.116] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:96:0)
[04:13:23.116] Timer tick, asking Buildbucket for the build status
[04:13:23.221] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:13:23.221] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:97:0) after 1m0s
[04:14:23.298] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:97:0)
[04:14:23.298] Timer tick, asking Buildbucket for the build status
[04:14:23.456] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:14:23.456] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:98:0) after 1m0s
[04:15:23.584] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:98:0)
[04:15:23.584] Timer tick, asking Buildbucket for the build status
[04:15:23.662] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:15:23.662] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:99:0) after 1m0s
[04:16:23.720] Handling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:99:0)
[04:16:23.720] Timer tick, asking Buildbucket for the build status
[04:16:23.840] Build 8853907619671859648: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:16:23.840] Scheduling timer "check-buildbucket-build-status" (chromium/linux-chromeos-dbg:9019337681561022272:100:0) after 1m0s
[04:17:09.055] Received PubSub notification, asking Buildbucket for the build status
[04:17:09.124] Build 8853907619671859648: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[04:17:09.124] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"completed_ts": "1614658628155334",
"created_by": "project:chromium",
"created_ts": "1614652725493516",
"id": "8853907619671859648",
"parameters_json": "{\"builder_name\": \"linux-chromeos-dbg\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"a7beda00182b1ad40d248eaa0dc0986d03073672\"}}",
"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\": \"a7beda00182b1ad40d248eaa0dc0986d03073672\", \"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-43-612k\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium.chromiumos\", \"buildername\": \"linux-chromeos-dbg\", \"buildnumber\": 22825, \"got_angle_revision\": \"6af0c03f9eadf548a42623a4692565b577142141\", \"got_dawn_revision\": \"931182485579d2eec3b24c1f2df646870f80da68\", \"got_nacl_revision\": \"abf3277f295c6c87f0b103f291ed5e3e73933b76\", \"got_revision\": \"a7beda00182b1ad40d248eaa0dc0986d03073672\", \"got_revision_cp\": \"refs/heads/master@{#858841}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"106e01583a3ac2fb950777390dde2dcc31a8f161\", \"got_v8_revision\": \"740e24e201f80287f4151c15f61fa684ea53dd3c\", \"got_v8_revision_cp\": \"refs/heads/9.1.9@{#1}\", \"got_webrtc_revision\": \"376cf384ac689eca0bf8d4d1d3a3cf80888d3fbb\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33348}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mirrored_builders\": [\"tryserver.chromium.chromiumos:linux-chromeos-dbg\", \"tryserver.chromium.chromiumos:linux-chromeos-compile-dbg\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"a7beda00182b1ad40d248eaa0dc0986d03073672\", \"swarm_hashes_refs/heads/master(at){#858841}_without_patch\": {\"absl_hardening_tests\": \"998a3a81d711c3cef0ae92658e7be35de71d8340\", \"accessibility_unittests\": \"e1f1c3c87cd612433ad80ae3f20c5790691bd561\", \"angle_unittests\": \"9d87437ddab25882f2541639c889b39ee5668f1d\", \"app_list_unittests\": \"322dccbf981d0057a5c6f420f589775d3ffd599d\", \"app_shell_unittests\": \"59ca05272fb5b343a9c362f6cffdb165bba29d5c\", \"ash_unittests\": \"71204c2ad8f91022b62709a8bb31290d47ed6c9c\", \"aura_unittests\": \"4106ad3a171cf140a77f065a2904d7861d058d2f\", \"base_unittests\": \"995b68d09bf99ee3cd701462ed2bd79fe1301859\", \"base_util_unittests\": \"b66f74c15060897d6c6410898598c7769a94f02e\", \"blink_common_unittests\": \"e738bbb606abe76e954445632122b170b05ef91f\", \"blink_fuzzer_unittests\": \"f67e9281c395023bfa0f2e8cf956ab621328a781\", \"blink_heap_unittests\": \"c42b9824e7edc41b2661014f97bafac508c51a3b\", \"blink_platform_unittests\": \"5406cfe0bb16e933b28f660345cee79fd4f8577b\", \"blink_unittests\": \"3946f4d61db60d6a059442f04f259668cf6ca0b4\", \"boringssl_crypto_tests\": \"a038bb819cab010b936ac8e71a1653994defd43f\", \"boringssl_ssl_tests\": \"582c09d8b1258a65a577dc50e778f5cbba6063be\", \"browser_tests\": \"a56070a9aebead843188ecb1984a1de0753c246b\", \"capture_unittests\": \"245db128a89643d665622595dd365724f4312635\", \"cast_unittests\": \"0debd907fdabe26161d36855441c4f6d54f3b341\", \"cc_unittests\": \"cd36c01f33ba6b3b62ece63f06c151020bfc0bf9\", \"chrome_app_unittests\": \"4ebed184ea8ac72f1d94783d432996c4d571446a\", \"chromedriver_unittests\": \"1c2d418d37a8b7085acbfdfefc2a862b88fab62c\", \"chromeos_components_unittests\": \"b058d88fd2abda732b829e6b6c52bdf8123048cb\", \"chromeos_unittests\": \"c16ef85321939325d22fffe01918a10729d386f7\", \"color_unittests\": \"293cddd1cc83263024d11d074303e64fb7ce6010\", \"components_browsertests\": \"d5f0f3c7f0b5b390b4ded9b457828730946a5119\", \"components_unittests\": \"4d99b9370905b403c9c9b419ce86acd4b14c5a3c\", \"compositor_unittests\": \"6c6208a20d7910b0a0a9aa2e8e8a7af172ebc5a2\", \"content_browsertests\": \"9bd0e19dcc006aa72a46e381432b191fd75ac1bb\", \"content_unittests\": \"3dd3182f209bd6372fcf637161765f3efecf1527\", \"crashpad_tests\": \"329292a662b9eb4a31de0c2977b9912046d39651\", \"crypto_unittests\": \"7a16cba02bf26f3f463ac6f57d820144dccc0afa\", \"dbus_unittests\": \"f415946d0142bc0ab2b9a784ddbec1eaa7a478bb\", \"device_unittests\": \"bf07cf1cf7c137a6fdf24f93707050bdfb78f13c\", \"display_unittests\": \"03ccf46f1537329af16303484e2d2531584770f5\", \"events_unittests\": \"d63b67ea148366cd5b63eca9126c5d08f9304211\", \"exo_unittests\": \"0142532c6ad4e452bb077c623fa3122210d10f0c\", \"extensions_browsertests\": \"2fffda868c71c4ef7fb8ceeb7c21b0fd7bbc4cee\", \"extensions_unittests\": \"49bed3bc3e25459bb5c35c28ac889f7864676904\", \"filesystem_service_unittests\": \"ddec724c097861beeb9d2eb9f6d6749b556f0968\", \"gcm_unit_tests\": \"76ad9f9325c4c4d0fff872b46ee4f82d5e7d9399\", \"gfx_unittests\": \"e6a93df1c0d05084858cc466a77b01dd736c2e4c\", \"gin_unittests\": \"a6af407bbe1346c53efa692b1ae583509fa2421d\", \"gl_unittests_ozone\": \"25a1af9e549db827e907023819fc6be7c3c87dd7\", \"google_apis_unittests\": \"b7ce896bcbe5c14b2babf86b422b928abf0f9bea\", \"gpu_unittests\": \"f16fdf12f1e61cbbd5521a36b50c2a4449eeb045\", \"gwp_asan_unittests\": \"bbf8400f86d221737c1c8c3210a9c6e47e12fb98\", \"interactive_ui_tests\": \"9290169ab7e07ad11039cbfa485dd0b09e38c37e\", \"ipc_tests\": \"ed6a558815880f400531c228b1da72f5841ae95c\", \"jingle_unittests\": \"b0e2e70800e0dfeab8e0b3080a65ec7d436ebb57\", \"keyboard_unittests\": \"b873a4f790e87382bb4865eb3ec14efe6662b2d7\", \"latency_unittests\": \"c744af9b3adf87de47b9bfad4e527fe064354a26\", \"libjingle_xmpp_unittests\": \"7a8db62601a2bf5a9e38a3202b06d00123931746\", \"liburlpattern_unittests\": \"d358227ad6ea8881f7d5cf18960b464c413a780e\", \"media_blink_unittests\": \"035d8f6244db76edc39026bc18b0afc8780becf4\", \"media_unittests\": \"634450bdc3cac65d685f9b1047908149546c4cac\", \"message_center_unittests\": \"dc595b91b8d7d88adb6bc6adea29132e9598e0ff\", \"midi_unittests\": \"4c59973dafafadec42c925dbc431968cc45f532d\", \"mojo_core_unittests\": \"9e02db7e31c5ec09c52fde1c66d0b28859ef7bda\", \"mojo_unittests\": \"615e693b5ca2a499caf65c37340d4b9650c39913\", \"nacl_helper_nonsfi_unittests\": \"d83811178dc0343b27400c9d59afc8d0dcc18694\", \"nacl_loader_unittests\": \"d753ba2888602f7304e9e4612ad0a0c611d3494c\", \"native_theme_unittests\": \"81dc171082e3bcccb72839bee144e4f15b8594ae\", \"net_unittests\": \"570791147909699c594b01f66ed9a08342b0b892\", \"ozone_gl_unittests\": \"b2116a5a3f89de4d27603b4821ef5a12e216f2f9\", \"ozone_unittests\": \"3b868ba7852e82dd94b66e1880b1f59a2f6de6b1\", \"ozone_x11_unittests\": \"1a72d5eb9fb4a979db46c14e43ba80aeffd35874\", \"pdf_unittests\": \"c91d80dbcbc8441ab15a50b1ce60afabbe658585\", \"perfetto_unittests\": \"35a21b984a6276bcbd73d091f719ce7792423a29\", \"ppapi_unittests\": \"37c9d0509610df8d904ef226c9550587922ef1d5\", \"printing_unittests\": \"6848211edc59ab10fb99f4d18d19af89ee904b1c\", \"remoting_unittests\": \"d12d9b0abac18f6791cda46f46a32d4bc89948d3\", \"sandbox_linux_unittests\": \"fc7498d71e169b26db36f9fc37466936e12a7b40\", \"service_manager_unittests\": \"18c3949da58418cd719c11e9fc5928f89b55bbcb\", \"services_unittests\": \"6b64dd4d88d3a15c67a40db2ee911975246ec594\", \"shell_dialogs_unittests\": \"38df06650905f9a4c2daeebea479c6d76ea404ce\", \"shell_encryption_unittests\": \"fa334fed58dcd5dc2baa3c81a30508df1c253e4f\", \"skia_unittests\": \"9e89e056b3a2bf155e8951482d94bd445853e8f3\", \"snapshot_unittests\": \"788693932b93022dec62decc5957ef0afa4a033a\", \"sql_unittests\": \"e313a922bf6bc4d8a53d19770d886c28b0c2d083\", \"storage_unittests\": \"a2c7ae16d80f4b46e6d7578b8acc9c0375e07355\", \"sync_integration_tests\": \"871904af44d3030d53de1e633eec796ac1a9b98b\", \"traffic_annotation_auditor_unittests\": \"c0560d4a225f56e70dc57acbb8669c247bd32748\", \"ui_base_unittests\": \"35f9a0687b5b75bba14b42fe92abf1122a9014bd\", \"ui_chromeos_unittests\": \"c9c9fc6e9e8a8f34f7cd9e9271f7514434cf522b\", \"ui_touch_selection_unittests\": \"649c06896ff1bd7fe131026e1a7477d7ef6dba3c\", \"unit_tests\": \"df1a35fc6adb07812054f208db475b71585b08ba\", \"url_unittests\": \"540a17f8caccc6fdc2f62901128348ad45655d49\", \"usage_time_limit_unittests\": \"8bd14cccb85f4880d6aad624e470d7a961a38bee\", \"views_unittests\": \"56cbd7f75f93869964c84ba320f9bbef1d9cd057\", \"viz_unittests\": \"b0707d0fecb166bde7681cedfab4bd4c61328b51\", \"wayland_client_tests\": \"2522c4b5ceb0bac5bf483ace035eabababb4fa18\", \"wm_unittests\": \"9932500697ac38668c123d00b0496f60d2728ba7\", \"wtf_unittests\": \"b0554cfb42690b973ac4f0688ae4fab9df3bbf6a\", \"zlib_unittests\": \"f4b4d34298e9ea767c9079c568dc40cef2193cf3\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_4973d939604d11dcbaec68575e69c80c756ff63e355ab013b29b8bca26434b7c_v2\", \"builder_562e40d9a0016a631bf2d4b73416a93abb069b959f020aa1a03e04f54d5ec620_v2\", \"builder_5f931a5519f78feef046af549827aa56dc2e9b17853b60b3d0ae8ebd533780ee_v2\", \"builder_7a9f94695aa83f7478015e01762e75301e67c95c681ec0592232bd343861e191_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-43-612k\"], \"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\": [\"5712-339372b\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-d\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1614652727442161",
"status": "COMPLETED",
"status_changed_ts": "1614658628609754",
"tags": [
"build_address:luci.chromium.ci/linux-chromeos-dbg/22825",
"builder:linux-chromeos-dbg",
"buildset:commit/git/a7beda00182b1ad40d248eaa0dc0986d03073672",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/a7beda00182b1ad40d248eaa0dc0986d03073672",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9019337681561022272",
"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/8853907619671859648/+/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:52099ee3b0bb3c10",
"user_agent:luci-scheduler"
],
"updated_ts": "1614658628615666",
"url": "https://ci.chromium.org/b/8853907619671859648",
"utcnow_ts": "1614658629116911"
}
}
[04:17:09.124] Invocation finished in 1h38m24.815490819s with status SUCCEEDED