buildbucket: <
  server: "cr-buildbucket.appspot.com"
  bucket: "luci.chromium.ci"
  builder: "linux-official"
>

• a877216667c58b0b780e9ad6ca83c14c56b82346 (5 years ago)

{
  "branch": "refs/heads/master",
  "repository": "https://chromium.googlesource.com/chromium/src",
  "revision": "a877216667c58b0b780e9ad6ca83c14c56b82346"
}

• buildset:commit/git/a877216667c58b0b780e9ad6ca83c14c56b82346
• buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/a877216667c58b0b780e9ad6ca83c14c56b82346
• gitiles_ref:refs/heads/master

[23:52:41.773] New invocation is queued and will start shortly
[23:52:42.912] Starting the invocation (attempt 1)
[23:52:42.957] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[23:52:42.957] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[23:52:42.957] Buildbucket request:
{
  "bucket": "luci.chromium.ci",
  "client_operation_id": "9041997369654522736",
  "parameters_json": "{\"builder_name\":\"linux-official\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"a877216667c58b0b780e9ad6ca83c14c56b82346\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:linux-official",
    "scheduler_invocation_id:9041997369654522736",
    "scheduler_job_id:chromium/linux-official",
    "user_agent:luci-scheduler",
    "buildset:commit/git/a877216667c58b0b780e9ad6ca83c14c56b82346",
    "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/a877216667c58b0b780e9ad6ca83c14c56b82346",
    "gitiles_ref:refs/heads/master"
  ]
}
[23:52:44.087] Buildbucket response:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "created_by": "project:chromium",
    "created_ts": "1593042763218604",
    "id": "8876567307473688768",
    "parameters_json": "{\"builder_name\": \"linux-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"a877216667c58b0b780e9ad6ca83c14c56b82346\"}}",
    "project": "chromium",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1593042763918429",
    "tags": [
      "build_address:luci.chromium.ci/linux-official/21",
      "builder:linux-official",
      "buildset:commit/git/a877216667c58b0b780e9ad6ca83c14c56b82346",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/a877216667c58b0b780e9ad6ca83c14c56b82346",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9041997369654522736",
      "scheduler_job_id:chromium/linux-official",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8876567307473688768/+/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": "1593042763918598",
    "url": "https://ci.chromium.org/b/8876567307473688768",
    "utcnow_ts": "1593042764076606"
  }
}
[23:52:44.087] Task URL: https://ci.chromium.org/b/8876567307473688768
[23:52:44.087] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:2:0) after 1m0s
[23:52:55.777] Received PubSub notification, asking Buildbucket for the build status
[23:52:55.873] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:44.194] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:2:0)
[23:53:44.194] Timer tick, asking Buildbucket for the build status
[23:53:44.801] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:44.801] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:4:0) after 1m0s
[23:54:44.818] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:4:0)
[23:54:44.818] Timer tick, asking Buildbucket for the build status
[23:54:45.013] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:45.013] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:5:0) after 1m0s
[23:55:45.045] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:5:0)
[23:55:45.045] Timer tick, asking Buildbucket for the build status
[23:55:45.251] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:45.251] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:6:0) after 1m0s
[23:56:45.291] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:6:0)
[23:56:45.291] Timer tick, asking Buildbucket for the build status
[23:56:45.463] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:45.463] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:7:0) after 1m0s
[23:57:45.487] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:7:0)
[23:57:45.487] Timer tick, asking Buildbucket for the build status
[23:57:45.952] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:57:45.952] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:8:0) after 1m0s
[23:58:46.004] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:8:0)
[23:58:46.004] Timer tick, asking Buildbucket for the build status
[23:58:51.702] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:58:51.702] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:9:0) after 1m0s
[23:59:51.758] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:9:0)
[23:59:51.758] Timer tick, asking Buildbucket for the build status
[23:59:51.984] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:59:51.984] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:10:0) after 1m0s
[00:00:52.016] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:10:0)
[00:00:52.016] Timer tick, asking Buildbucket for the build status
[00:00:52.762] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:00:52.762] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:11:0) after 1m0s
[00:01:52.803] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:11:0)
[00:01:52.803] Timer tick, asking Buildbucket for the build status
[00:01:53.225] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:01:53.225] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:12:0) after 1m0s
[00:02:53.289] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:12:0)
[00:02:53.289] Timer tick, asking Buildbucket for the build status
[00:02:53.509] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:02:53.509] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:13:0) after 1m0s
[00:03:53.559] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:13:0)
[00:03:53.559] Timer tick, asking Buildbucket for the build status
[00:03:54.371] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:03:54.371] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:14:0) after 1m0s
[00:04:54.363] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:14:0)
[00:04:54.363] Timer tick, asking Buildbucket for the build status
[00:04:54.779] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:54.779] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:15:0) after 1m0s
[00:05:54.766] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:15:0)
[00:05:54.766] Timer tick, asking Buildbucket for the build status
[00:05:54.865] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:54.865] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:16:0) after 1m0s
[00:06:54.915] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:16:0)
[00:06:54.915] Timer tick, asking Buildbucket for the build status
[00:06:55.122] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:55.122] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:17:0) after 1m0s
[00:07:55.127] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:17:0)
[00:07:55.127] Timer tick, asking Buildbucket for the build status
[00:07:55.292] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:55.292] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:18:0) after 1m0s
[00:08:55.362] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:18:0)
[00:08:55.362] Timer tick, asking Buildbucket for the build status
[00:08:55.753] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:08:55.753] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:19:0) after 1m0s
[00:09:55.793] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:19:0)
[00:09:55.793] Timer tick, asking Buildbucket for the build status
[00:09:57.446] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:57.446] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:20:0) after 1m0s
[00:10:57.468] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:20:0)
[00:10:57.468] Timer tick, asking Buildbucket for the build status
[00:10:57.742] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:57.742] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:21:0) after 1m0s
[00:11:57.814] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:21:0)
[00:11:57.814] Timer tick, asking Buildbucket for the build status
[00:11:58.208] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:58.208] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:22:0) after 1m0s
[00:12:58.219] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:22:0)
[00:12:58.219] Timer tick, asking Buildbucket for the build status
[00:12:58.460] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:58.460] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:23:0) after 1m0s
[00:13:58.542] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:23:0)
[00:13:58.542] Timer tick, asking Buildbucket for the build status
[00:13:58.765] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:13:58.765] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:24:0) after 1m0s
[00:14:58.807] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:24:0)
[00:14:58.807] Timer tick, asking Buildbucket for the build status
[00:14:59.094] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:59.094] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:25:0) after 1m0s
[00:15:59.124] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:25:0)
[00:15:59.124] Timer tick, asking Buildbucket for the build status
[00:15:59.299] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:59.299] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:26:0) after 1m0s
[00:16:59.348] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:26:0)
[00:16:59.348] Timer tick, asking Buildbucket for the build status
[00:16:59.636] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:59.636] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:27:0) after 1m0s
[00:17:59.629] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:27:0)
[00:17:59.629] Timer tick, asking Buildbucket for the build status
[00:17:59.823] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:59.823] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:28:0) after 1m0s
[00:18:59.866] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:28:0)
[00:18:59.866] Timer tick, asking Buildbucket for the build status
[00:19:00.342] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:00.342] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:29:0) after 1m0s
[00:20:00.664] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:29:0)
[00:20:00.664] Timer tick, asking Buildbucket for the build status
[00:20:01.652] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:01.652] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:30:0) after 1m0s
[00:21:01.728] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:30:0)
[00:21:01.728] Timer tick, asking Buildbucket for the build status
[00:21:02.178] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:02.178] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:31:0) after 1m0s
[00:22:02.755] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:31:0)
[00:22:02.755] Timer tick, asking Buildbucket for the build status
[00:22:03.658] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:03.659] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:32:0) after 1m0s
[00:23:03.875] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:32:0)
[00:23:03.875] Timer tick, asking Buildbucket for the build status
[00:23:04.153] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:04.153] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:33:0) after 1m0s
[00:24:04.159] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:33:0)
[00:24:04.159] Timer tick, asking Buildbucket for the build status
[00:24:04.481] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:04.481] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:34:0) after 1m0s
[00:25:04.508] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:34:0)
[00:25:04.508] Timer tick, asking Buildbucket for the build status
[00:25:05.004] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:05.004] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:35:0) after 1m0s
[00:26:05.106] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:35:0)
[00:26:05.107] Timer tick, asking Buildbucket for the build status
[00:26:05.611] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:05.611] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:36:0) after 1m0s
[00:27:05.658] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:36:0)
[00:27:05.658] Timer tick, asking Buildbucket for the build status
[00:27:06.088] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:06.088] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:37:0) after 1m0s
[00:28:06.117] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:37:0)
[00:28:06.117] Timer tick, asking Buildbucket for the build status
[00:28:06.385] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:06.385] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:38:0) after 1m0s
[00:29:06.417] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:38:0)
[00:29:06.417] Timer tick, asking Buildbucket for the build status
[00:29:06.647] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:29:06.647] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:39:0) after 1m0s
[00:30:06.715] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:39:0)
[00:30:06.715] Timer tick, asking Buildbucket for the build status
[00:30:07.242] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:30:07.242] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:40:0) after 1m0s
[00:31:07.328] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:40:0)
[00:31:07.328] Timer tick, asking Buildbucket for the build status
[00:31:07.753] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:31:07.753] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:41:0) after 1m0s
[00:32:07.881] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:41:0)
[00:32:07.881] Timer tick, asking Buildbucket for the build status
[00:32:08.027] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:32:08.027] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:42:0) after 1m0s
[00:33:08.073] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:42:0)
[00:33:08.073] Timer tick, asking Buildbucket for the build status
[00:33:08.846] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:33:08.846] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:43:0) after 1m0s
[00:34:08.938] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:43:0)
[00:34:08.938] Timer tick, asking Buildbucket for the build status
[00:34:10.825] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:34:10.825] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:44:0) after 1m0s
[00:35:10.892] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:44:0)
[00:35:10.892] Timer tick, asking Buildbucket for the build status
[00:35:11.110] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:35:11.110] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:45:0) after 1m0s
[00:36:11.145] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:45:0)
[00:36:11.145] Timer tick, asking Buildbucket for the build status
[00:36:11.312] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:36:11.312] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:46:0) after 1m0s
[00:37:11.420] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:46:0)
[00:37:11.420] Timer tick, asking Buildbucket for the build status
[00:37:11.587] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:37:11.587] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:47:0) after 1m0s
[00:38:11.691] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:47:0)
[00:38:11.691] Timer tick, asking Buildbucket for the build status
[00:38:12.122] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:38:12.122] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:48:0) after 1m0s
[00:39:12.334] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:48:0)
[00:39:12.334] Timer tick, asking Buildbucket for the build status
[00:39:12.505] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:39:12.505] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:49:0) after 1m0s
[00:40:12.565] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:49:0)
[00:40:12.565] Timer tick, asking Buildbucket for the build status
[00:40:12.796] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:40:12.797] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:50:0) after 1m0s
[00:41:12.813] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:50:0)
[00:41:12.813] Timer tick, asking Buildbucket for the build status
[00:41:12.994] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:41:12.994] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:51:0) after 1m0s
[00:42:13.053] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:51:0)
[00:42:13.053] Timer tick, asking Buildbucket for the build status
[00:42:13.784] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:42:13.784] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:52:0) after 1m0s
[00:43:13.824] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:52:0)
[00:43:13.825] Timer tick, asking Buildbucket for the build status
[00:43:14.055] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:43:14.055] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:53:0) after 1m0s
[00:44:14.146] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:53:0)
[00:44:14.146] Timer tick, asking Buildbucket for the build status
[00:44:14.694] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:44:14.694] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:54:0) after 1m0s
[00:45:14.744] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:54:0)
[00:45:14.744] Timer tick, asking Buildbucket for the build status
[00:45:14.944] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:45:14.944] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:55:0) after 1m0s
[00:46:15.116] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:55:0)
[00:46:15.116] Timer tick, asking Buildbucket for the build status
[00:46:15.337] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:46:15.337] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:56:0) after 1m0s
[00:47:15.444] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:56:0)
[00:47:15.444] Timer tick, asking Buildbucket for the build status
[00:47:15.641] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:47:15.641] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:57:0) after 1m0s
[00:48:16.940] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:57:0)
[00:48:16.940] Timer tick, asking Buildbucket for the build status
[00:48:18.195] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:48:18.195] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:58:0) after 1m0s
[00:49:18.509] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:58:0)
[00:49:18.509] Timer tick, asking Buildbucket for the build status
[00:49:18.716] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:49:18.716] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:59:0) after 1m0s
[00:50:18.775] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:59:0)
[00:50:18.775] Timer tick, asking Buildbucket for the build status
[00:50:18.954] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:50:18.954] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:60:0) after 1m0s
[00:51:19.182] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:60:0)
[00:51:19.182] Timer tick, asking Buildbucket for the build status
[00:51:19.527] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:51:19.527] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:61:0) after 1m0s
[00:52:19.652] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:61:0)
[00:52:19.653] Timer tick, asking Buildbucket for the build status
[00:52:19.796] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:52:19.796] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:62:0) after 1m0s
[00:53:19.974] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:62:0)
[00:53:19.974] Timer tick, asking Buildbucket for the build status
[00:53:23.337] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:23.337] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:63:0) after 1m0s
[00:54:23.516] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:63:0)
[00:54:23.516] Timer tick, asking Buildbucket for the build status
[00:54:23.641] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:54:23.641] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:64:0) after 1m0s
[00:55:23.709] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:64:0)
[00:55:23.709] Timer tick, asking Buildbucket for the build status
[00:55:24.046] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:55:24.046] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:65:0) after 1m0s
[00:56:24.081] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:65:0)
[00:56:24.081] Timer tick, asking Buildbucket for the build status
[00:56:24.252] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:56:24.252] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:66:0) after 1m0s
[00:57:24.366] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:66:0)
[00:57:24.367] Timer tick, asking Buildbucket for the build status
[00:57:25.389] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:57:25.389] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:67:0) after 1m0s
[00:58:25.592] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:67:0)
[00:58:25.592] Timer tick, asking Buildbucket for the build status
[00:58:25.923] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:58:25.923] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:68:0) after 1m0s
[00:59:25.968] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:68:0)
[00:59:25.968] Timer tick, asking Buildbucket for the build status
[00:59:26.348] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:59:26.348] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:69:0) after 1m0s
[01:00:26.393] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:69:0)
[01:00:26.393] Timer tick, asking Buildbucket for the build status
[01:00:26.504] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:00:26.504] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:70:0) after 1m0s
[01:01:26.534] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:70:0)
[01:01:26.534] Timer tick, asking Buildbucket for the build status
[01:01:26.690] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:01:26.690] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:71:0) after 1m0s
[01:02:26.734] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:71:0)
[01:02:26.734] Timer tick, asking Buildbucket for the build status
[01:02:26.915] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:02:26.915] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:72:0) after 1m0s
[01:03:26.936] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:72:0)
[01:03:26.936] Timer tick, asking Buildbucket for the build status
[01:03:31.382] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:03:31.382] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:73:0) after 1m0s
[01:04:31.442] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:73:0)
[01:04:31.442] Timer tick, asking Buildbucket for the build status
[01:04:31.713] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:04:31.713] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:74:0) after 1m0s
[01:05:31.882] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:74:0)
[01:05:31.882] Timer tick, asking Buildbucket for the build status
[01:05:33.712] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:05:33.712] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:75:0) after 1m0s
[01:06:33.753] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:75:0)
[01:06:33.753] Timer tick, asking Buildbucket for the build status
[01:06:34.011] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:06:34.011] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:76:0) after 1m0s
[01:07:34.244] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:76:0)
[01:07:34.244] Timer tick, asking Buildbucket for the build status
[01:07:34.747] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:07:34.747] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:77:0) after 1m0s
[01:08:34.902] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:77:0)
[01:08:34.902] Timer tick, asking Buildbucket for the build status
[01:08:38.941] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:08:38.941] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:78:0) after 1m0s
[01:09:39.057] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:78:0)
[01:09:39.057] Timer tick, asking Buildbucket for the build status
[01:09:39.780] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:09:39.780] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:79:0) after 1m0s
[01:10:39.874] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:79:0)
[01:10:39.874] Timer tick, asking Buildbucket for the build status
[01:10:39.991] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:10:39.991] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:80:0) after 1m0s
[01:11:40.041] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:80:0)
[01:11:40.041] Timer tick, asking Buildbucket for the build status
[01:11:40.232] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:11:40.232] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:81:0) after 1m0s
[01:12:40.260] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:81:0)
[01:12:40.260] Timer tick, asking Buildbucket for the build status
[01:12:40.499] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:12:40.499] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:82:0) after 1m0s
[01:13:40.523] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:82:0)
[01:13:40.523] Timer tick, asking Buildbucket for the build status
[01:13:45.268] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:13:45.268] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:83:0) after 1m0s
[01:14:45.371] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:83:0)
[01:14:45.371] Timer tick, asking Buildbucket for the build status
[01:14:45.541] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:14:45.541] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:84:0) after 1m0s
[01:15:45.532] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:84:0)
[01:15:45.532] Timer tick, asking Buildbucket for the build status
[01:15:45.693] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:15:45.693] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:85:0) after 1m0s
[01:16:45.723] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:85:0)
[01:16:45.723] Timer tick, asking Buildbucket for the build status
[01:16:45.894] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:16:45.894] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:86:0) after 1m0s
[01:17:45.923] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:86:0)
[01:17:45.923] Timer tick, asking Buildbucket for the build status
[01:17:46.086] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:17:46.086] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:87:0) after 1m0s
[01:18:46.141] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:87:0)
[01:18:46.141] Timer tick, asking Buildbucket for the build status
[01:18:49.439] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:18:49.440] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:88:0) after 1m0s
[01:19:49.477] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:88:0)
[01:19:49.477] Timer tick, asking Buildbucket for the build status
[01:19:49.864] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:19:49.864] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:89:0) after 1m0s
[01:20:49.968] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:89:0)
[01:20:49.968] Timer tick, asking Buildbucket for the build status
[01:20:50.165] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:20:50.165] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:90:0) after 1m0s
[01:21:50.213] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:90:0)
[01:21:50.213] Timer tick, asking Buildbucket for the build status
[01:21:50.435] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:21:50.436] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:91:0) after 1m0s
[01:22:50.412] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:91:0)
[01:22:50.412] Timer tick, asking Buildbucket for the build status
[01:22:50.632] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:22:50.632] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:92:0) after 1m0s
[01:23:50.671] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:92:0)
[01:23:50.671] Timer tick, asking Buildbucket for the build status
[01:23:51.353] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:23:51.353] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:93:0) after 1m0s
[01:24:51.371] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:93:0)
[01:24:51.371] Timer tick, asking Buildbucket for the build status
[01:24:51.513] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:24:51.513] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:94:0) after 1m0s
[01:25:51.569] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:94:0)
[01:25:51.569] Timer tick, asking Buildbucket for the build status
[01:25:51.746] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:25:51.746] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:95:0) after 1m0s
[01:26:51.767] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:95:0)
[01:26:51.767] Timer tick, asking Buildbucket for the build status
[01:26:51.920] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:26:51.920] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:96:0) after 1m0s
[01:27:51.953] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:96:0)
[01:27:51.953] Timer tick, asking Buildbucket for the build status
[01:27:52.115] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:27:52.115] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:97:0) after 1m0s
[01:28:52.319] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:97:0)
[01:28:52.319] Timer tick, asking Buildbucket for the build status
[01:28:54.151] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:28:54.151] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:98:0) after 1m0s
[01:29:54.183] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:98:0)
[01:29:54.183] Timer tick, asking Buildbucket for the build status
[01:29:54.294] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:29:54.294] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:99:0) after 1m0s
[01:30:54.378] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:99:0)
[01:30:54.378] Timer tick, asking Buildbucket for the build status
[01:30:54.606] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:30:54.606] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:100:0) after 1m0s
[01:31:54.626] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:100:0)
[01:31:54.626] Timer tick, asking Buildbucket for the build status
[01:31:54.791] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:31:54.791] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:101:0) after 1m0s
[01:32:54.789] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:101:0)
[01:32:54.789] Timer tick, asking Buildbucket for the build status
[01:32:55.252] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:32:55.252] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:102:0) after 1m0s
[01:33:55.470] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:102:0)
[01:33:55.470] Timer tick, asking Buildbucket for the build status
[01:33:56.387] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:33:56.387] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:103:0) after 1m0s
[01:34:56.423] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:103:0)
[01:34:56.423] Timer tick, asking Buildbucket for the build status
[01:34:56.562] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:34:56.562] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:104:0) after 1m0s
[01:35:56.661] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:104:0)
[01:35:56.661] Timer tick, asking Buildbucket for the build status
[01:35:56.791] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:35:56.792] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:105:0) after 1m0s
[01:36:56.895] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:105:0)
[01:36:56.896] Timer tick, asking Buildbucket for the build status
[01:36:58.107] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:36:58.107] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:106:0) after 1m0s
[01:37:58.169] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:106:0)
[01:37:58.169] Timer tick, asking Buildbucket for the build status
[01:37:58.343] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:37:58.343] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:107:0) after 1m0s
[01:38:58.415] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:107:0)
[01:38:58.415] Timer tick, asking Buildbucket for the build status
[01:38:58.914] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:38:58.914] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:108:0) after 1m0s
[01:39:58.990] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:108:0)
[01:39:58.990] Timer tick, asking Buildbucket for the build status
[01:39:59.155] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:39:59.155] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:109:0) after 1m0s
[01:40:59.217] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:109:0)
[01:40:59.217] Timer tick, asking Buildbucket for the build status
[01:40:59.390] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:40:59.390] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:110:0) after 1m0s
[01:41:59.409] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:110:0)
[01:41:59.409] Timer tick, asking Buildbucket for the build status
[01:41:59.560] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:41:59.560] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:111:0) after 1m0s
[01:42:59.607] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:111:0)
[01:42:59.607] Timer tick, asking Buildbucket for the build status
[01:42:59.770] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:42:59.770] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:112:0) after 1m0s
[01:43:59.811] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:112:0)
[01:43:59.811] Timer tick, asking Buildbucket for the build status
[01:44:00.544] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:44:00.544] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:113:0) after 1m0s
[01:45:00.523] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:113:0)
[01:45:00.523] Timer tick, asking Buildbucket for the build status
[01:45:00.680] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:45:00.680] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:114:0) after 1m0s
[01:46:01.674] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:114:0)
[01:46:01.674] Timer tick, asking Buildbucket for the build status
[01:46:01.875] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:46:01.876] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:115:0) after 1m0s
[01:47:01.918] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:115:0)
[01:47:01.918] Timer tick, asking Buildbucket for the build status
[01:47:02.053] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:47:02.053] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:116:0) after 1m0s
[01:48:02.132] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:116:0)
[01:48:02.132] Timer tick, asking Buildbucket for the build status
[01:48:02.315] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:48:02.315] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:117:0) after 1m0s
[01:49:02.414] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:117:0)
[01:49:02.414] Timer tick, asking Buildbucket for the build status
[01:49:03.771] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:49:03.771] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:118:0) after 1m0s
[01:50:03.844] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:118:0)
[01:50:03.844] Timer tick, asking Buildbucket for the build status
[01:50:04.185] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:50:04.185] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:119:0) after 1m0s
[01:51:04.353] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:119:0)
[01:51:04.353] Timer tick, asking Buildbucket for the build status
[01:51:04.548] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:51:04.548] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:120:0) after 1m0s
[01:52:04.755] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:120:0)
[01:52:04.755] Timer tick, asking Buildbucket for the build status
[01:52:04.941] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:52:04.941] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:121:0) after 1m0s
[01:53:05.119] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:121:0)
[01:53:05.119] Timer tick, asking Buildbucket for the build status
[01:53:05.305] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:53:05.305] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:122:0) after 1m0s
[01:54:05.496] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:122:0)
[01:54:05.496] Timer tick, asking Buildbucket for the build status
[01:54:05.744] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:54:05.744] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:123:0) after 1m0s
[01:55:05.813] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:123:0)
[01:55:05.813] Timer tick, asking Buildbucket for the build status
[01:55:05.949] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:55:05.949] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:124:0) after 1m0s
[01:56:05.945] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:124:0)
[01:56:05.945] Timer tick, asking Buildbucket for the build status
[01:56:07.486] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:56:07.486] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:125:0) after 1m0s
[01:57:07.600] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:125:0)
[01:57:07.600] Timer tick, asking Buildbucket for the build status
[01:57:07.769] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:57:07.769] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:126:0) after 1m0s
[01:58:07.826] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:126:0)
[01:58:07.826] Timer tick, asking Buildbucket for the build status
[01:58:08.097] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:58:08.097] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:127:0) after 1m0s
[01:59:08.148] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:127:0)
[01:59:08.148] Timer tick, asking Buildbucket for the build status
[01:59:08.914] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:59:08.914] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:128:0) after 1m0s
[02:00:09.011] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:128:0)
[02:00:09.011] Timer tick, asking Buildbucket for the build status
[02:00:09.259] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:00:09.259] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:129:0) after 1m0s
[02:01:09.393] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:129:0)
[02:01:09.393] Timer tick, asking Buildbucket for the build status
[02:01:09.574] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:01:09.574] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:130:0) after 1m0s
[02:02:09.587] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:130:0)
[02:02:09.587] Timer tick, asking Buildbucket for the build status
[02:02:10.190] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:02:10.190] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:131:0) after 1m0s
[02:03:10.219] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:131:0)
[02:03:10.219] Timer tick, asking Buildbucket for the build status
[02:03:10.808] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:03:10.808] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:132:0) after 1m0s
[02:04:10.843] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:132:0)
[02:04:10.843] Timer tick, asking Buildbucket for the build status
[02:04:14.353] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:04:14.353] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:133:0) after 1m0s
[02:05:14.500] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:133:0)
[02:05:14.500] Timer tick, asking Buildbucket for the build status
[02:05:14.706] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:05:14.706] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:134:0) after 1m0s
[02:06:14.851] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:134:0)
[02:06:14.851] Timer tick, asking Buildbucket for the build status
[02:06:14.978] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:06:14.979] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:135:0) after 1m0s
[02:07:16.687] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:135:0)
[02:07:16.687] Timer tick, asking Buildbucket for the build status
[02:07:16.868] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:07:16.868] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:136:0) after 1m0s
[02:08:16.910] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:136:0)
[02:08:16.910] Timer tick, asking Buildbucket for the build status
[02:08:17.055] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:08:17.055] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:137:0) after 1m0s
[02:09:17.604] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:137:0)
[02:09:17.604] Timer tick, asking Buildbucket for the build status
[02:09:18.105] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:09:18.105] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:138:0) after 1m0s
[02:10:18.351] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:138:0)
[02:10:18.351] Timer tick, asking Buildbucket for the build status
[02:10:18.533] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:10:18.533] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:139:0) after 1m0s
[02:11:18.755] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:139:0)
[02:11:18.755] Timer tick, asking Buildbucket for the build status
[02:11:18.985] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:11:18.985] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:140:0) after 1m0s
[02:12:19.297] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:140:0)
[02:12:19.297] Timer tick, asking Buildbucket for the build status
[02:12:19.412] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:12:19.412] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:141:0) after 1m0s
[02:13:19.613] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:141:0)
[02:13:19.613] Timer tick, asking Buildbucket for the build status
[02:13:19.907] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:13:19.907] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:142:0) after 1m0s
[02:14:20.079] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:142:0)
[02:14:20.079] Timer tick, asking Buildbucket for the build status
[02:14:20.173] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:14:20.173] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:143:0) after 1m0s
[02:15:20.258] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:143:0)
[02:15:20.258] Timer tick, asking Buildbucket for the build status
[02:15:20.400] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:15:20.400] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:144:0) after 1m0s
[02:16:20.542] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:144:0)
[02:16:20.542] Timer tick, asking Buildbucket for the build status
[02:16:22.224] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:16:22.224] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:145:0) after 1m0s
[02:17:22.280] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:145:0)
[02:17:22.280] Timer tick, asking Buildbucket for the build status
[02:17:22.468] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:17:22.468] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:146:0) after 1m0s
[02:18:22.503] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:146:0)
[02:18:22.503] Timer tick, asking Buildbucket for the build status
[02:18:25.091] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:18:25.091] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:147:0) after 1m0s
[02:19:25.108] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:147:0)
[02:19:25.108] Timer tick, asking Buildbucket for the build status
[02:19:25.243] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:19:25.243] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:148:0) after 1m0s
[02:20:25.258] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:148:0)
[02:20:25.258] Timer tick, asking Buildbucket for the build status
[02:20:25.557] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:20:25.557] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:149:0) after 1m0s
[02:21:25.587] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:149:0)
[02:21:25.587] Timer tick, asking Buildbucket for the build status
[02:21:25.817] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:21:25.817] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:150:0) after 1m0s
[02:22:25.861] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:150:0)
[02:22:25.861] Timer tick, asking Buildbucket for the build status
[02:22:26.026] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:22:26.026] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:151:0) after 1m0s
[02:23:26.035] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:151:0)
[02:23:26.035] Timer tick, asking Buildbucket for the build status
[02:23:26.223] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:23:26.223] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:152:0) after 1m0s
[02:24:26.292] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:152:0)
[02:24:26.292] Timer tick, asking Buildbucket for the build status
[02:24:26.498] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:24:26.498] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:153:0) after 1m0s
[02:25:26.798] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:153:0)
[02:25:26.798] Timer tick, asking Buildbucket for the build status
[02:25:27.240] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:25:27.240] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:154:0) after 1m0s
[02:26:27.295] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:154:0)
[02:26:27.295] Timer tick, asking Buildbucket for the build status
[02:26:27.499] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:26:27.499] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:155:0) after 1m0s
[02:27:27.718] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:155:0)
[02:27:27.718] Timer tick, asking Buildbucket for the build status
[02:27:27.972] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:27:27.972] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:156:0) after 1m0s
[02:28:28.117] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:156:0)
[02:28:28.117] Timer tick, asking Buildbucket for the build status
[02:28:28.545] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:28:28.545] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:157:0) after 1m0s
[02:29:28.696] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:157:0)
[02:29:28.696] Timer tick, asking Buildbucket for the build status
[02:29:28.860] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:29:28.861] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:158:0) after 1m0s
[02:30:28.910] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:158:0)
[02:30:28.910] Timer tick, asking Buildbucket for the build status
[02:30:29.142] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:30:29.142] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:159:0) after 1m0s
[02:31:29.228] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:159:0)
[02:31:29.228] Timer tick, asking Buildbucket for the build status
[02:31:29.362] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:31:29.362] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:160:0) after 1m0s
[02:32:30.681] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:160:0)
[02:32:30.681] Timer tick, asking Buildbucket for the build status
[02:32:30.966] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:32:30.966] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:161:0) after 1m0s
[02:33:30.988] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:161:0)
[02:33:30.988] Timer tick, asking Buildbucket for the build status
[02:33:33.837] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:33:33.837] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:162:0) after 1m0s
[02:34:33.918] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:162:0)
[02:34:33.918] Timer tick, asking Buildbucket for the build status
[02:34:36.593] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:34:36.593] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:163:0) after 1m0s
[02:35:36.661] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:163:0)
[02:35:36.661] Timer tick, asking Buildbucket for the build status
[02:35:36.905] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:35:36.905] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:164:0) after 1m0s
[02:36:36.977] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:164:0)
[02:36:36.977] Timer tick, asking Buildbucket for the build status
[02:36:38.330] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:36:38.330] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:165:0) after 1m0s
[02:37:38.397] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:165:0)
[02:37:38.397] Timer tick, asking Buildbucket for the build status
[02:37:38.604] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:37:38.604] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:166:0) after 1m0s
[02:38:38.637] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:166:0)
[02:38:38.637] Timer tick, asking Buildbucket for the build status
[02:38:39.647] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:38:39.647] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:167:0) after 1m0s
[02:39:39.705] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:167:0)
[02:39:39.705] Timer tick, asking Buildbucket for the build status
[02:39:40.007] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:39:40.007] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:168:0) after 1m0s
[02:40:40.034] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:168:0)
[02:40:40.034] Timer tick, asking Buildbucket for the build status
[02:40:40.224] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:40:40.224] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:169:0) after 1m0s
[02:41:40.286] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:169:0)
[02:41:40.286] Timer tick, asking Buildbucket for the build status
[02:41:40.442] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:41:40.442] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:170:0) after 1m0s
[02:42:40.545] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:170:0)
[02:42:40.545] Timer tick, asking Buildbucket for the build status
[02:42:40.723] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:42:40.723] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:171:0) after 1m0s
[02:43:40.747] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:171:0)
[02:43:40.747] Timer tick, asking Buildbucket for the build status
[02:43:41.747] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:43:41.747] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:172:0) after 1m0s
[02:44:41.776] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:172:0)
[02:44:41.776] Timer tick, asking Buildbucket for the build status
[02:44:41.980] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:44:41.980] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:173:0) after 1m0s
[02:45:42.118] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:173:0)
[02:45:42.118] Timer tick, asking Buildbucket for the build status
[02:45:42.322] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:45:42.322] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:174:0) after 1m0s
[02:46:42.464] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:174:0)
[02:46:42.465] Timer tick, asking Buildbucket for the build status
[02:46:42.652] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:46:42.652] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:175:0) after 1m0s
[02:47:42.718] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:175:0)
[02:47:42.718] Timer tick, asking Buildbucket for the build status
[02:47:42.902] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:47:42.902] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:176:0) after 1m0s
[02:48:42.962] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:176:0)
[02:48:42.962] Timer tick, asking Buildbucket for the build status
[02:48:46.516] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:48:46.516] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:177:0) after 1m0s
[02:49:46.627] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:177:0)
[02:49:46.627] Timer tick, asking Buildbucket for the build status
[02:49:46.825] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:49:46.825] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:178:0) after 1m0s
[02:50:46.867] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:178:0)
[02:50:46.867] Timer tick, asking Buildbucket for the build status
[02:50:47.103] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:50:47.103] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:179:0) after 1m0s
[02:51:47.166] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:179:0)
[02:51:47.166] Timer tick, asking Buildbucket for the build status
[02:51:47.514] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:51:47.514] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:180:0) after 1m0s
[02:52:47.565] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:180:0)
[02:52:47.565] Timer tick, asking Buildbucket for the build status
[02:52:47.720] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:52:47.720] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:181:0) after 1m0s
[02:53:47.786] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:181:0)
[02:53:47.786] Timer tick, asking Buildbucket for the build status
[02:53:48.748] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:53:48.748] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:182:0) after 1m0s
[02:54:48.773] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:182:0)
[02:54:48.773] Timer tick, asking Buildbucket for the build status
[02:54:48.941] Build 8876567307473688768: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:54:48.941] Scheduling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:183:0) after 1m0s
[02:55:49.013] Handling timer "check-buildbucket-build-status" (chromium/linux-official:9041997369654522736:183:0)
[02:55:49.013] Timer tick, asking Buildbucket for the build status
[02:55:49.083] Build 8876567307473688768: status "COMPLETED", result "CANCELED", failure_reason "", cancelation_reason "TIMEOUT"
[02:55:49.083] Buildbucket build:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "cancelation_reason": "TIMEOUT",
    "completed_ts": "1593053748150677",
    "created_by": "project:chromium",
    "created_ts": "1593042763218604",
    "id": "8876567307473688768",
    "parameters_json": "{\"builder_name\": \"linux-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"a877216667c58b0b780e9ad6ca83c14c56b82346\"}}",
    "project": "chromium",
    "result": "CANCELED",
    "result_details_json": "{\"properties\": {\"$build/chromium_tests\": {\"bucketed_triggers\": true}, \"$build/goma\": {\"enable_ats\": true, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"luci-chromium-ci-xenial-us-central1-b-8-12-70p2\", \"branch\": \"refs/heads/master\", \"buildername\": \"linux-official\", \"buildnumber\": 21, \"got_angle_revision\": \"054aeeed3b4c6d57c2fd0b8f1a77a49471937f3e\", \"got_dawn_revision\": \"10e4a44ce6512887861f1b5c6801655029bf8350\", \"got_nacl_revision\": \"fd20fafa8ec19700e12daa031bf792bae8b6bb21\", \"got_revision\": \"a877216667c58b0b780e9ad6ca83c14c56b82346\", \"got_revision_cp\": \"refs/heads/master@{#782138}\", \"got_swarming_client_revision\": \"4c095d04179dc725a300085ae21fe3b79900d072\", \"got_swiftshader_revision\": \"eb0a25a189b75d950ae4f87c00f8d63f190d82a0\", \"got_v8_revision\": \"a7f8bc434b35c3122a859f094fa541febd74ec7c\", \"got_v8_revision_cp\": \"refs/heads/8.5.210@{#1}\", \"got_webrtc_revision\": \"75fd127640bdf1729af6b4a25875e6d01f1570e0\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#31558}\", \"mastername\": \"chromium\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"a877216667c58b0b780e9ad6ca83c14c56b82346\"}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_5c91f31d9663b1e17a568e2208dcfdacb922b7eb6243478e1941c158f72ac154_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-b-8-12-70p2\"], \"image\": [\"chrome-xenial-20052400-59eb8623c93\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5218-123b763\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1593042774803568",
    "status": "COMPLETED",
    "status_changed_ts": "1593053748587743",
    "tags": [
      "build_address:luci.chromium.ci/linux-official/21",
      "builder:linux-official",
      "buildset:commit/git/a877216667c58b0b780e9ad6ca83c14c56b82346",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/a877216667c58b0b780e9ad6ca83c14c56b82346",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9041997369654522736",
      "scheduler_job_id:chromium/linux-official",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8876567307473688768/+/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:4d01912f2e9b2b10",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1593053748623380",
    "url": "https://ci.chromium.org/b/8876567307473688768",
    "utcnow_ts": "1593053749072696"
  }
}
[02:55:49.083] Invocation finished in 3h3m7.327736675s with status FAILED