Status: SUCCEEDED
Triggered by: -
Duration: 4 hours
Actions:

Definition (rev 835dd06986af6863f902c628becb4df908d0fc20)

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

Incoming triggers

Incoming properties

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

Incoming tags

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

Debug log (UTC)

[11:52:22.490] New invocation is queued and will start shortly
[11:52:23.652] Starting the invocation (attempt 1)
[11:52:23.697] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[11:52:23.697] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[11:52:23.697] Buildbucket request:
{
  "bucket": "luci.chromium.ci",
  "client_operation_id": "9020027625519147888",
  "parameters_json": "{\"builder_name\":\"win32-official\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"ecef70257810e677530925854194671d27064eeb\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:win32-official",
    "scheduler_invocation_id:9020027625519147888",
    "scheduler_job_id:chromium/win32-official",
    "user_agent:luci-scheduler",
    "buildset:commit/git/ecef70257810e677530925854194671d27064eeb",
    "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/ecef70257810e677530925854194671d27064eeb",
    "gitiles_ref:refs/heads/master"
  ]
}
[11:52:25.103] Buildbucket response:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary": true,
    "canary_preference": "CANARY",
    "created_by": "project:chromium",
    "created_ts": "1613994743881194",
    "id": "8854597563398402416",
    "parameters_json": "{\"builder_name\": \"win32-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"ecef70257810e677530925854194671d27064eeb\"}}",
    "project": "chromium",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1613994744877530",
    "tags": [
      "build_address:luci.chromium.ci/win32-official/1592",
      "builder:win32-official",
      "buildset:commit/git/ecef70257810e677530925854194671d27064eeb",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/ecef70257810e677530925854194671d27064eeb",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9020027625519147888",
      "scheduler_job_id:chromium/win32-official",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8854597563398402416/+/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": "1613994744878339",
    "url": "https://ci.chromium.org/b/8854597563398402416",
    "utcnow_ts": "1613994745089600"
  }
}
[11:52:25.103] Task URL: https://ci.chromium.org/b/8854597563398402416
[11:52:25.103] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:2:0) after 1m0s
[11:53:25.223] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:2:0)
[11:53:25.223] Timer tick, asking Buildbucket for the build status
[11:53:25.433] Build 8854597563398402416: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:53:25.433] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:3:0) after 1m0s
[11:54:14.009] Received PubSub notification, asking Buildbucket for the build status
[11:54:14.296] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:54:25.516] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:3:0)
[11:54:25.516] Timer tick, asking Buildbucket for the build status
[11:54:25.711] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:54:25.711] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:5:0) after 1m0s
[11:55:25.871] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:5:0)
[11:55:25.872] Timer tick, asking Buildbucket for the build status
[11:55:25.942] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:55:25.942] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:6:0) after 1m0s
[11:56:26.103] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:6:0)
[11:56:26.103] Timer tick, asking Buildbucket for the build status
[11:56:26.248] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:56:26.248] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:7:0) after 1m0s
[11:57:26.279] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:7:0)
[11:57:26.279] Timer tick, asking Buildbucket for the build status
[11:57:26.395] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:57:26.395] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:8:0) after 1m0s
[11:58:26.505] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:8:0)
[11:58:26.505] Timer tick, asking Buildbucket for the build status
[11:58:26.696] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:58:26.696] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:9:0) after 1m0s
[11:59:26.794] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:9:0)
[11:59:26.794] Timer tick, asking Buildbucket for the build status
[11:59:26.893] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:59:26.893] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:10:0) after 1m0s
[12:00:27.057] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:10:0)
[12:00:27.057] Timer tick, asking Buildbucket for the build status
[12:00:27.181] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:00:27.181] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:11:0) after 1m0s
[12:01:27.351] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:11:0)
[12:01:27.351] Timer tick, asking Buildbucket for the build status
[12:01:27.444] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:01:27.444] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:12:0) after 1m0s
[12:02:27.586] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:12:0)
[12:02:27.586] Timer tick, asking Buildbucket for the build status
[12:02:27.672] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:02:27.672] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:13:0) after 1m0s
[12:03:27.720] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:13:0)
[12:03:27.720] Timer tick, asking Buildbucket for the build status
[12:03:28.473] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:03:28.473] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:14:0) after 1m0s
[12:04:28.706] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:14:0)
[12:04:28.706] Timer tick, asking Buildbucket for the build status
[12:04:28.778] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:04:28.778] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:15:0) after 1m0s
[12:05:28.945] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:15:0)
[12:05:28.945] Timer tick, asking Buildbucket for the build status
[12:05:29.023] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:05:29.023] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:16:0) after 1m0s
[12:06:29.137] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:16:0)
[12:06:29.137] Timer tick, asking Buildbucket for the build status
[12:06:29.225] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:06:29.225] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:17:0) after 1m0s
[12:07:29.425] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:17:0)
[12:07:29.425] Timer tick, asking Buildbucket for the build status
[12:07:29.531] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:07:29.531] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:18:0) after 1m0s
[12:08:29.542] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:18:0)
[12:08:29.542] Timer tick, asking Buildbucket for the build status
[12:08:30.493] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:08:30.493] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:19:0) after 1m0s
[12:09:30.521] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:19:0)
[12:09:30.521] Timer tick, asking Buildbucket for the build status
[12:09:30.869] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:09:30.869] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:20:0) after 1m0s
[12:10:31.038] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:20:0)
[12:10:31.038] Timer tick, asking Buildbucket for the build status
[12:10:31.211] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:10:31.211] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:21:0) after 1m0s
[12:11:31.354] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:21:0)
[12:11:31.354] Timer tick, asking Buildbucket for the build status
[12:11:31.636] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:11:31.636] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:22:0) after 1m0s
[12:12:31.732] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:22:0)
[12:12:31.733] Timer tick, asking Buildbucket for the build status
[12:12:31.838] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:12:31.838] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:23:0) after 1m0s
[12:13:31.969] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:23:0)
[12:13:31.969] Timer tick, asking Buildbucket for the build status
[12:13:32.076] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:13:32.076] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:24:0) after 1m0s
[12:14:32.162] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:24:0)
[12:14:32.163] Timer tick, asking Buildbucket for the build status
[12:14:32.304] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:14:32.304] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:25:0) after 1m0s
[12:15:32.373] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:25:0)
[12:15:32.373] Timer tick, asking Buildbucket for the build status
[12:15:32.474] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:15:32.474] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:26:0) after 1m0s
[12:16:32.564] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:26:0)
[12:16:32.564] Timer tick, asking Buildbucket for the build status
[12:16:32.647] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:16:32.647] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:27:0) after 1m0s
[12:17:32.772] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:27:0)
[12:17:32.772] Timer tick, asking Buildbucket for the build status
[12:17:32.897] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:17:32.897] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:28:0) after 1m0s
[12:18:33.035] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:28:0)
[12:18:33.035] Timer tick, asking Buildbucket for the build status
[12:18:33.128] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:18:33.128] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:29:0) after 1m0s
[12:19:33.185] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:29:0)
[12:19:33.186] Timer tick, asking Buildbucket for the build status
[12:19:33.260] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:19:33.260] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:30:0) after 1m0s
[12:20:33.377] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:30:0)
[12:20:33.377] Timer tick, asking Buildbucket for the build status
[12:20:33.473] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:20:33.473] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:31:0) after 1m0s
[12:21:33.643] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:31:0)
[12:21:33.643] Timer tick, asking Buildbucket for the build status
[12:21:33.739] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:21:33.739] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:32:0) after 1m0s
[12:22:33.930] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:32:0)
[12:22:33.930] Timer tick, asking Buildbucket for the build status
[12:22:34.033] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:22:34.033] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:33:0) after 1m0s
[12:23:34.096] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:33:0)
[12:23:34.096] Timer tick, asking Buildbucket for the build status
[12:23:34.180] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:23:34.181] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:34:0) after 1m0s
[12:24:34.264] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:34:0)
[12:24:34.264] Timer tick, asking Buildbucket for the build status
[12:24:34.438] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:24:34.438] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:35:0) after 1m0s
[12:25:34.500] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:35:0)
[12:25:34.500] Timer tick, asking Buildbucket for the build status
[12:25:34.571] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:25:34.571] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:36:0) after 1m0s
[12:26:34.660] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:36:0)
[12:26:34.660] Timer tick, asking Buildbucket for the build status
[12:26:34.747] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:26:34.747] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:37:0) after 1m0s
[12:27:34.876] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:37:0)
[12:27:34.876] Timer tick, asking Buildbucket for the build status
[12:27:35.022] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:27:35.022] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:38:0) after 1m0s
[12:28:35.074] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:38:0)
[12:28:35.074] Timer tick, asking Buildbucket for the build status
[12:28:35.394] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:28:35.394] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:39:0) after 1m0s
[12:29:35.492] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:39:0)
[12:29:35.492] Timer tick, asking Buildbucket for the build status
[12:29:35.611] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:29:35.611] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:40:0) after 1m0s
[12:30:35.756] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:40:0)
[12:30:35.756] Timer tick, asking Buildbucket for the build status
[12:30:35.885] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:30:35.886] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:41:0) after 1m0s
[12:31:36.221] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:41:0)
[12:31:36.221] Timer tick, asking Buildbucket for the build status
[12:31:36.298] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:31:36.298] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:42:0) after 1m0s
[12:32:36.570] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:42:0)
[12:32:36.570] Timer tick, asking Buildbucket for the build status
[12:32:37.050] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:32:37.050] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:43:0) after 1m0s
[12:33:37.286] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:43:0)
[12:33:37.286] Timer tick, asking Buildbucket for the build status
[12:33:37.365] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:33:37.365] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:44:0) after 1m0s
[12:34:37.487] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:44:0)
[12:34:37.487] Timer tick, asking Buildbucket for the build status
[12:34:37.637] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:34:37.637] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:45:0) after 1m0s
[12:35:37.721] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:45:0)
[12:35:37.721] Timer tick, asking Buildbucket for the build status
[12:35:37.825] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:35:37.825] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:46:0) after 1m0s
[12:36:37.979] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:46:0)
[12:36:37.979] Timer tick, asking Buildbucket for the build status
[12:36:38.113] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:36:38.113] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:47:0) after 1m0s
[12:37:38.177] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:47:0)
[12:37:38.177] Timer tick, asking Buildbucket for the build status
[12:37:38.278] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:37:38.278] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:48:0) after 1m0s
[12:38:38.348] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:48:0)
[12:38:38.348] Timer tick, asking Buildbucket for the build status
[12:38:38.437] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:38:38.437] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:49:0) after 1m0s
[12:39:38.689] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:49:0)
[12:39:38.689] Timer tick, asking Buildbucket for the build status
[12:39:38.860] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:39:38.860] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:50:0) after 1m0s
[12:40:38.923] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:50:0)
[12:40:38.923] Timer tick, asking Buildbucket for the build status
[12:40:39.106] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:40:39.106] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:51:0) after 1m0s
[12:41:39.239] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:51:0)
[12:41:39.239] Timer tick, asking Buildbucket for the build status
[12:41:39.342] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:41:39.342] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:52:0) after 1m0s
[12:42:39.403] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:52:0)
[12:42:39.403] Timer tick, asking Buildbucket for the build status
[12:42:39.511] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:42:39.511] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:53:0) after 1m0s
[12:43:39.521] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:53:0)
[12:43:39.521] Timer tick, asking Buildbucket for the build status
[12:43:39.599] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:43:39.599] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:54:0) after 1m0s
[12:44:39.642] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:54:0)
[12:44:39.642] Timer tick, asking Buildbucket for the build status
[12:44:39.721] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:44:39.721] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:55:0) after 1m0s
[12:45:39.854] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:55:0)
[12:45:39.854] Timer tick, asking Buildbucket for the build status
[12:45:39.950] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:45:39.950] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:56:0) after 1m0s
[12:46:40.109] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:56:0)
[12:46:40.109] Timer tick, asking Buildbucket for the build status
[12:46:40.179] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:46:40.179] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:57:0) after 1m0s
[12:47:40.274] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:57:0)
[12:47:40.274] Timer tick, asking Buildbucket for the build status
[12:47:40.454] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:47:40.454] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:58:0) after 1m0s
[12:48:40.472] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:58:0)
[12:48:40.472] Timer tick, asking Buildbucket for the build status
[12:48:40.612] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:48:40.612] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:59:0) after 1m0s
[12:49:40.696] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:59:0)
[12:49:40.696] Timer tick, asking Buildbucket for the build status
[12:49:40.924] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:49:40.924] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:60:0) after 1m0s
[12:50:40.968] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:60:0)
[12:50:40.968] Timer tick, asking Buildbucket for the build status
[12:50:41.082] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:50:41.082] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:61:0) after 1m0s
[12:51:41.125] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:61:0)
[12:51:41.125] Timer tick, asking Buildbucket for the build status
[12:51:41.355] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:51:41.355] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:62:0) after 1m0s
[12:52:41.326] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:62:0)
[12:52:41.326] Timer tick, asking Buildbucket for the build status
[12:52:41.545] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:52:41.545] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:63:0) after 1m0s
[12:53:41.527] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:63:0)
[12:53:41.527] Timer tick, asking Buildbucket for the build status
[12:53:41.717] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:53:41.717] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:64:0) after 1m0s
[12:54:41.819] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:64:0)
[12:54:41.819] Timer tick, asking Buildbucket for the build status
[12:54:41.999] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:54:41.999] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:65:0) after 1m0s
[12:55:42.024] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:65:0)
[12:55:42.024] Timer tick, asking Buildbucket for the build status
[12:55:42.140] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:55:42.140] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:66:0) after 1m0s
[12:56:42.208] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:66:0)
[12:56:42.208] Timer tick, asking Buildbucket for the build status
[12:56:42.329] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:56:42.329] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:67:0) after 1m0s
[12:57:42.374] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:67:0)
[12:57:42.374] Timer tick, asking Buildbucket for the build status
[12:57:42.481] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:57:42.481] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:68:0) after 1m0s
[12:58:42.515] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:68:0)
[12:58:42.515] Timer tick, asking Buildbucket for the build status
[12:58:42.581] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:58:42.581] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:69:0) after 1m0s
[12:59:42.593] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:69:0)
[12:59:42.593] Timer tick, asking Buildbucket for the build status
[12:59:42.737] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:59:42.737] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:70:0) after 1m0s
[13:00:42.738] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:70:0)
[13:00:42.738] Timer tick, asking Buildbucket for the build status
[13:00:42.926] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:00:42.926] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:71:0) after 1m0s
[13:01:43.008] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:71:0)
[13:01:43.008] Timer tick, asking Buildbucket for the build status
[13:01:43.114] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:01:43.114] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:72:0) after 1m0s
[13:02:43.203] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:72:0)
[13:02:43.203] Timer tick, asking Buildbucket for the build status
[13:02:43.344] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:02:43.344] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:73:0) after 1m0s
[13:03:43.373] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:73:0)
[13:03:43.373] Timer tick, asking Buildbucket for the build status
[13:03:43.781] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:03:43.781] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:74:0) after 1m0s
[13:04:43.784] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:74:0)
[13:04:43.784] Timer tick, asking Buildbucket for the build status
[13:04:43.858] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:04:43.858] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:75:0) after 1m0s
[13:05:43.844] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:75:0)
[13:05:43.844] Timer tick, asking Buildbucket for the build status
[13:05:43.932] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:05:43.932] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:76:0) after 1m0s
[13:06:43.934] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:76:0)
[13:06:43.934] Timer tick, asking Buildbucket for the build status
[13:06:44.015] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:06:44.015] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:77:0) after 1m0s
[13:07:44.059] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:77:0)
[13:07:44.059] Timer tick, asking Buildbucket for the build status
[13:07:44.444] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:07:44.444] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:78:0) after 1m0s
[13:08:44.446] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:78:0)
[13:08:44.446] Timer tick, asking Buildbucket for the build status
[13:08:44.525] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:08:44.525] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:79:0) after 1m0s
[13:09:44.566] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:79:0)
[13:09:44.566] Timer tick, asking Buildbucket for the build status
[13:09:44.799] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:09:44.799] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:80:0) after 1m0s
[13:10:44.839] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:80:0)
[13:10:44.839] Timer tick, asking Buildbucket for the build status
[13:10:45.041] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:10:45.041] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:81:0) after 1m0s
[13:11:45.136] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:81:0)
[13:11:45.136] Timer tick, asking Buildbucket for the build status
[13:11:45.388] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:11:45.388] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:82:0) after 1m0s
[13:12:45.427] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:82:0)
[13:12:45.427] Timer tick, asking Buildbucket for the build status
[13:12:45.535] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:12:45.535] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:83:0) after 1m0s
[13:13:45.589] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:83:0)
[13:13:45.589] Timer tick, asking Buildbucket for the build status
[13:13:45.715] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:13:45.715] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:84:0) after 1m0s
[13:14:45.790] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:84:0)
[13:14:45.790] Timer tick, asking Buildbucket for the build status
[13:14:45.892] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:14:45.892] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:85:0) after 1m0s
[13:15:45.913] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:85:0)
[13:15:45.913] Timer tick, asking Buildbucket for the build status
[13:15:45.986] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:15:45.986] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:86:0) after 1m0s
[13:16:46.012] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:86:0)
[13:16:46.012] Timer tick, asking Buildbucket for the build status
[13:16:46.095] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:16:46.095] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:87:0) after 1m0s
[13:17:46.092] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:87:0)
[13:17:46.092] Timer tick, asking Buildbucket for the build status
[13:17:46.549] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:17:46.549] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:88:0) after 1m0s
[13:18:46.570] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:88:0)
[13:18:46.570] Timer tick, asking Buildbucket for the build status
[13:18:46.801] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:18:46.801] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:89:0) after 1m0s
[13:19:46.826] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:89:0)
[13:19:46.826] Timer tick, asking Buildbucket for the build status
[13:19:46.940] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:19:46.940] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:90:0) after 1m0s
[13:20:46.960] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:90:0)
[13:20:46.960] Timer tick, asking Buildbucket for the build status
[13:20:47.036] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:20:47.036] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:91:0) after 1m0s
[13:21:47.068] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:91:0)
[13:21:47.068] Timer tick, asking Buildbucket for the build status
[13:21:47.159] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:21:47.159] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:92:0) after 1m0s
[13:22:47.178] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:92:0)
[13:22:47.178] Timer tick, asking Buildbucket for the build status
[13:22:47.436] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:22:47.436] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:93:0) after 1m0s
[13:23:47.529] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:93:0)
[13:23:47.529] Timer tick, asking Buildbucket for the build status
[13:23:47.632] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:23:47.632] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:94:0) after 1m0s
[13:24:47.688] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:94:0)
[13:24:47.688] Timer tick, asking Buildbucket for the build status
[13:24:47.770] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:24:47.770] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:95:0) after 1m0s
[13:25:48.041] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:95:0)
[13:25:48.041] Timer tick, asking Buildbucket for the build status
[13:25:48.122] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:25:48.122] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:96:0) after 1m0s
[13:26:48.961] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:96:0)
[13:26:48.961] Timer tick, asking Buildbucket for the build status
[13:26:49.216] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:26:49.216] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:97:0) after 1m0s
[13:27:49.285] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:97:0)
[13:27:49.285] Timer tick, asking Buildbucket for the build status
[13:27:49.393] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:27:49.393] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:98:0) after 1m0s
[13:28:49.485] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:98:0)
[13:28:49.485] Timer tick, asking Buildbucket for the build status
[13:28:49.559] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:28:49.559] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:99:0) after 1m0s
[13:29:49.655] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:99:0)
[13:29:49.655] Timer tick, asking Buildbucket for the build status
[13:29:49.757] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:29:49.757] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:100:0) after 1m0s
[13:30:49.785] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:100:0)
[13:30:49.785] Timer tick, asking Buildbucket for the build status
[13:30:49.925] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:30:49.925] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:101:0) after 1m0s
[13:31:49.950] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:101:0)
[13:31:49.950] Timer tick, asking Buildbucket for the build status
[13:31:50.032] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:31:50.032] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:102:0) after 1m0s
[13:32:50.065] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:102:0)
[13:32:50.065] Timer tick, asking Buildbucket for the build status
[13:32:50.150] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:32:50.150] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:103:0) after 1m0s
[13:33:50.199] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:103:0)
[13:33:50.199] Timer tick, asking Buildbucket for the build status
[13:33:50.300] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:33:50.300] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:104:0) after 1m0s
[13:34:50.338] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:104:0)
[13:34:50.338] Timer tick, asking Buildbucket for the build status
[13:34:50.415] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:34:50.415] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:105:0) after 1m0s
[13:35:50.447] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:105:0)
[13:35:50.447] Timer tick, asking Buildbucket for the build status
[13:35:50.537] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:35:50.537] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:106:0) after 1m0s
[13:36:50.561] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:106:0)
[13:36:50.561] Timer tick, asking Buildbucket for the build status
[13:36:50.735] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:36:50.735] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:107:0) after 1m0s
[13:37:50.765] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:107:0)
[13:37:50.765] Timer tick, asking Buildbucket for the build status
[13:37:50.857] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:37:50.857] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:108:0) after 1m0s
[13:38:50.952] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:108:0)
[13:38:50.952] Timer tick, asking Buildbucket for the build status
[13:38:51.061] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:38:51.061] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:109:0) after 1m0s
[13:39:51.122] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:109:0)
[13:39:51.122] Timer tick, asking Buildbucket for the build status
[13:39:51.221] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:39:51.221] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:110:0) after 1m0s
[13:40:51.291] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:110:0)
[13:40:51.291] Timer tick, asking Buildbucket for the build status
[13:40:51.437] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:40:51.437] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:111:0) after 1m0s
[13:41:51.518] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:111:0)
[13:41:51.518] Timer tick, asking Buildbucket for the build status
[13:41:51.799] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:41:51.799] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:112:0) after 1m0s
[13:42:51.881] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:112:0)
[13:42:51.881] Timer tick, asking Buildbucket for the build status
[13:42:52.009] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:42:52.009] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:113:0) after 1m0s
[13:43:52.062] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:113:0)
[13:43:52.062] Timer tick, asking Buildbucket for the build status
[13:43:52.244] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:43:52.244] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:114:0) after 1m0s
[13:44:52.497] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:114:0)
[13:44:52.497] Timer tick, asking Buildbucket for the build status
[13:44:52.606] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:44:52.606] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:115:0) after 1m0s
[13:45:52.728] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:115:0)
[13:45:52.728] Timer tick, asking Buildbucket for the build status
[13:45:52.899] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:45:52.899] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:116:0) after 1m0s
[13:46:52.997] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:116:0)
[13:46:52.997] Timer tick, asking Buildbucket for the build status
[13:46:53.064] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:46:53.064] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:117:0) after 1m0s
[13:47:53.143] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:117:0)
[13:47:53.143] Timer tick, asking Buildbucket for the build status
[13:47:53.237] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:47:53.237] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:118:0) after 1m0s
[13:48:53.352] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:118:0)
[13:48:53.352] Timer tick, asking Buildbucket for the build status
[13:48:53.600] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:48:53.600] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:119:0) after 1m0s
[13:49:53.724] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:119:0)
[13:49:53.724] Timer tick, asking Buildbucket for the build status
[13:49:53.987] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:49:53.987] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:120:0) after 1m0s
[13:50:54.107] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:120:0)
[13:50:54.107] Timer tick, asking Buildbucket for the build status
[13:50:54.193] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:50:54.193] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:121:0) after 1m0s
[13:51:54.296] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:121:0)
[13:51:54.296] Timer tick, asking Buildbucket for the build status
[13:51:54.364] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:51:54.364] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:122:0) after 1m0s
[13:52:54.387] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:122:0)
[13:52:54.387] Timer tick, asking Buildbucket for the build status
[13:52:54.820] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:52:54.820] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:123:0) after 1m0s
[13:53:54.863] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:123:0)
[13:53:54.863] Timer tick, asking Buildbucket for the build status
[13:53:54.932] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:53:54.932] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:124:0) after 1m0s
[13:54:55.002] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:124:0)
[13:54:55.002] Timer tick, asking Buildbucket for the build status
[13:54:55.157] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:54:55.157] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:125:0) after 1m0s
[13:55:55.234] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:125:0)
[13:55:55.234] Timer tick, asking Buildbucket for the build status
[13:55:55.351] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:55:55.351] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:126:0) after 1m0s
[13:56:55.414] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:126:0)
[13:56:55.414] Timer tick, asking Buildbucket for the build status
[13:56:55.493] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:56:55.493] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:127:0) after 1m0s
[13:57:55.498] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:127:0)
[13:57:55.498] Timer tick, asking Buildbucket for the build status
[13:57:55.832] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:57:55.832] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:128:0) after 1m0s
[13:58:55.855] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:128:0)
[13:58:55.855] Timer tick, asking Buildbucket for the build status
[13:58:55.941] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:58:55.941] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:129:0) after 1m0s
[13:59:56.014] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:129:0)
[13:59:56.014] Timer tick, asking Buildbucket for the build status
[13:59:56.236] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:59:56.236] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:130:0) after 1m0s
[14:00:56.261] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:130:0)
[14:00:56.261] Timer tick, asking Buildbucket for the build status
[14:00:56.735] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:00:56.735] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:131:0) after 1m0s
[14:01:56.760] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:131:0)
[14:01:56.760] Timer tick, asking Buildbucket for the build status
[14:01:56.849] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:01:56.849] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:132:0) after 1m0s
[14:02:56.850] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:132:0)
[14:02:56.850] Timer tick, asking Buildbucket for the build status
[14:02:56.983] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:02:56.983] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:133:0) after 1m0s
[14:03:57.031] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:133:0)
[14:03:57.031] Timer tick, asking Buildbucket for the build status
[14:03:57.169] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:03:57.169] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:134:0) after 1m0s
[14:04:57.185] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:134:0)
[14:04:57.185] Timer tick, asking Buildbucket for the build status
[14:04:57.283] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:04:57.283] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:135:0) after 1m0s
[14:05:57.290] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:135:0)
[14:05:57.290] Timer tick, asking Buildbucket for the build status
[14:05:57.600] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:05:57.600] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:136:0) after 1m0s
[14:06:57.597] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:136:0)
[14:06:57.597] Timer tick, asking Buildbucket for the build status
[14:06:57.680] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:57.680] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:137:0) after 1m0s
[14:07:57.681] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:137:0)
[14:07:57.681] Timer tick, asking Buildbucket for the build status
[14:07:57.783] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:07:57.783] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:138:0) after 1m0s
[14:08:57.803] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:138:0)
[14:08:57.803] Timer tick, asking Buildbucket for the build status
[14:08:57.931] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:08:57.931] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:139:0) after 1m0s
[14:09:57.931] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:139:0)
[14:09:57.931] Timer tick, asking Buildbucket for the build status
[14:09:58.003] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:09:58.003] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:140:0) after 1m0s
[14:10:58.044] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:140:0)
[14:10:58.044] Timer tick, asking Buildbucket for the build status
[14:10:58.124] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:58.124] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:141:0) after 1m0s
[14:11:58.224] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:141:0)
[14:11:58.224] Timer tick, asking Buildbucket for the build status
[14:11:58.394] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:58.394] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:142:0) after 1m0s
[14:12:58.523] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:142:0)
[14:12:58.523] Timer tick, asking Buildbucket for the build status
[14:12:58.750] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:58.750] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:143:0) after 1m0s
[14:13:58.826] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:143:0)
[14:13:58.826] Timer tick, asking Buildbucket for the build status
[14:13:58.928] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:58.928] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:144:0) after 1m0s
[14:14:58.991] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:144:0)
[14:14:58.991] Timer tick, asking Buildbucket for the build status
[14:14:59.086] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:59.086] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:145:0) after 1m0s
[14:15:59.147] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:145:0)
[14:15:59.147] Timer tick, asking Buildbucket for the build status
[14:15:59.223] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:59.223] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:146:0) after 1m0s
[14:16:59.261] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:146:0)
[14:16:59.261] Timer tick, asking Buildbucket for the build status
[14:16:59.375] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:16:59.375] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:147:0) after 1m0s
[14:17:59.426] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:147:0)
[14:17:59.426] Timer tick, asking Buildbucket for the build status
[14:17:59.739] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:17:59.739] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:148:0) after 1m0s
[14:18:59.822] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:148:0)
[14:18:59.822] Timer tick, asking Buildbucket for the build status
[14:19:00.233] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:19:00.233] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:149:0) after 1m0s
[14:20:00.322] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:149:0)
[14:20:00.322] Timer tick, asking Buildbucket for the build status
[14:20:00.398] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:20:00.398] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:150:0) after 1m0s
[14:21:00.382] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:150:0)
[14:21:00.382] Timer tick, asking Buildbucket for the build status
[14:21:00.470] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:21:00.470] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:151:0) after 1m0s
[14:22:01.395] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:151:0)
[14:22:01.395] Timer tick, asking Buildbucket for the build status
[14:22:01.505] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:22:01.505] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:152:0) after 1m0s
[14:23:01.671] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:152:0)
[14:23:01.671] Timer tick, asking Buildbucket for the build status
[14:23:02.014] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:23:02.014] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:153:0) after 1m0s
[14:24:02.038] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:153:0)
[14:24:02.038] Timer tick, asking Buildbucket for the build status
[14:24:02.112] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:24:02.113] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:154:0) after 1m0s
[14:25:02.178] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:154:0)
[14:25:02.178] Timer tick, asking Buildbucket for the build status
[14:25:02.326] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:25:02.326] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:155:0) after 1m0s
[14:26:02.359] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:155:0)
[14:26:02.359] Timer tick, asking Buildbucket for the build status
[14:26:02.586] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:26:02.586] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:156:0) after 1m0s
[14:27:03.063] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:156:0)
[14:27:03.063] Timer tick, asking Buildbucket for the build status
[14:27:03.238] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:27:03.238] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:157:0) after 1m0s
[14:28:04.224] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:157:0)
[14:28:04.224] Timer tick, asking Buildbucket for the build status
[14:28:04.328] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:28:04.328] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:158:0) after 1m0s
[14:29:04.576] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:158:0)
[14:29:04.576] Timer tick, asking Buildbucket for the build status
[14:29:04.659] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:29:04.659] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:159:0) after 1m0s
[14:30:04.690] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:159:0)
[14:30:04.690] Timer tick, asking Buildbucket for the build status
[14:30:04.770] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:30:04.770] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:160:0) after 1m0s
[14:31:05.085] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:160:0)
[14:31:05.085] Timer tick, asking Buildbucket for the build status
[14:31:05.181] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:31:05.181] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:161:0) after 1m0s
[14:32:05.234] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:161:0)
[14:32:05.234] Timer tick, asking Buildbucket for the build status
[14:32:05.450] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:32:05.450] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:162:0) after 1m0s
[14:33:05.447] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:162:0)
[14:33:05.447] Timer tick, asking Buildbucket for the build status
[14:33:05.584] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:33:05.584] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:163:0) after 1m0s
[14:34:05.630] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:163:0)
[14:34:05.630] Timer tick, asking Buildbucket for the build status
[14:34:05.720] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:34:05.720] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:164:0) after 1m0s
[14:35:05.755] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:164:0)
[14:35:05.755] Timer tick, asking Buildbucket for the build status
[14:35:06.001] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:35:06.001] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:165:0) after 1m0s
[14:36:06.038] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:165:0)
[14:36:06.038] Timer tick, asking Buildbucket for the build status
[14:36:06.215] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:36:06.215] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:166:0) after 1m0s
[14:37:06.322] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:166:0)
[14:37:06.322] Timer tick, asking Buildbucket for the build status
[14:37:06.417] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:37:06.417] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:167:0) after 1m0s
[14:38:06.432] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:167:0)
[14:38:06.432] Timer tick, asking Buildbucket for the build status
[14:38:06.979] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:38:06.979] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:168:0) after 1m0s
[14:39:07.013] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:168:0)
[14:39:07.013] Timer tick, asking Buildbucket for the build status
[14:39:07.132] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:39:07.132] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:169:0) after 1m0s
[14:40:07.203] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:169:0)
[14:40:07.203] Timer tick, asking Buildbucket for the build status
[14:40:07.416] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:40:07.416] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:170:0) after 1m0s
[14:41:07.519] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:170:0)
[14:41:07.519] Timer tick, asking Buildbucket for the build status
[14:41:07.671] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:41:07.671] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:171:0) after 1m0s
[14:42:07.744] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:171:0)
[14:42:07.744] Timer tick, asking Buildbucket for the build status
[14:42:07.825] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:42:07.825] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:172:0) after 1m0s
[14:43:07.863] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:172:0)
[14:43:07.863] Timer tick, asking Buildbucket for the build status
[14:43:07.962] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:43:07.962] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:173:0) after 1m0s
[14:44:08.045] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:173:0)
[14:44:08.045] Timer tick, asking Buildbucket for the build status
[14:44:08.141] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:44:08.141] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:174:0) after 1m0s
[14:45:08.187] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:174:0)
[14:45:08.187] Timer tick, asking Buildbucket for the build status
[14:45:08.258] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:45:08.258] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:175:0) after 1m0s
[14:46:08.330] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:175:0)
[14:46:08.330] Timer tick, asking Buildbucket for the build status
[14:46:08.405] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:46:08.405] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:176:0) after 1m0s
[14:47:08.468] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:176:0)
[14:47:08.468] Timer tick, asking Buildbucket for the build status
[14:47:09.178] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:09.178] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:177:0) after 1m0s
[14:48:09.278] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:177:0)
[14:48:09.278] Timer tick, asking Buildbucket for the build status
[14:48:09.644] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:09.644] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:178:0) after 1m0s
[14:49:09.669] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:178:0)
[14:49:09.669] Timer tick, asking Buildbucket for the build status
[14:49:09.749] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:09.749] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:179:0) after 1m0s
[14:50:09.771] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:179:0)
[14:50:09.771] Timer tick, asking Buildbucket for the build status
[14:50:09.857] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:09.857] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:180:0) after 1m0s
[14:51:10.051] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:180:0)
[14:51:10.051] Timer tick, asking Buildbucket for the build status
[14:51:10.225] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:10.225] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:181:0) after 1m0s
[14:52:10.299] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:181:0)
[14:52:10.299] Timer tick, asking Buildbucket for the build status
[14:52:10.369] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:10.369] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:182:0) after 1m0s
[14:53:10.417] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:182:0)
[14:53:10.417] Timer tick, asking Buildbucket for the build status
[14:53:10.541] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:10.541] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:183:0) after 1m0s
[14:54:10.630] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:183:0)
[14:54:10.630] Timer tick, asking Buildbucket for the build status
[14:54:10.716] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:54:10.716] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:184:0) after 1m0s
[14:55:10.760] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:184:0)
[14:55:10.760] Timer tick, asking Buildbucket for the build status
[14:55:10.933] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:55:10.933] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:185:0) after 1m0s
[14:56:10.964] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:185:0)
[14:56:10.964] Timer tick, asking Buildbucket for the build status
[14:56:11.054] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:56:11.054] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:186:0) after 1m0s
[14:57:11.168] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:186:0)
[14:57:11.168] Timer tick, asking Buildbucket for the build status
[14:57:11.271] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:57:11.271] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:187:0) after 1m0s
[14:58:11.345] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:187:0)
[14:58:11.345] Timer tick, asking Buildbucket for the build status
[14:58:11.455] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:58:11.455] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:188:0) after 1m0s
[14:59:11.570] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:188:0)
[14:59:11.570] Timer tick, asking Buildbucket for the build status
[14:59:11.641] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:59:11.641] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:189:0) after 1m0s
[15:00:11.745] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:189:0)
[15:00:11.745] Timer tick, asking Buildbucket for the build status
[15:00:12.031] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:00:12.031] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:190:0) after 1m0s
[15:01:12.055] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:190:0)
[15:01:12.056] Timer tick, asking Buildbucket for the build status
[15:01:12.141] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:01:12.141] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:191:0) after 1m0s
[15:02:12.148] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:191:0)
[15:02:12.148] Timer tick, asking Buildbucket for the build status
[15:02:12.297] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:02:12.297] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:192:0) after 1m0s
[15:03:12.349] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:192:0)
[15:03:12.349] Timer tick, asking Buildbucket for the build status
[15:03:12.450] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:03:12.450] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:193:0) after 1m0s
[15:04:14.632] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:193:0)
[15:04:14.633] Timer tick, asking Buildbucket for the build status
[15:04:14.832] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:04:14.832] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:194:0) after 1m0s
[15:05:14.892] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:194:0)
[15:05:14.892] Timer tick, asking Buildbucket for the build status
[15:05:14.967] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:05:14.967] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:195:0) after 1m0s
[15:06:14.984] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:195:0)
[15:06:14.984] Timer tick, asking Buildbucket for the build status
[15:06:15.120] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:06:15.120] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:196:0) after 1m0s
[15:07:15.153] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:196:0)
[15:07:15.153] Timer tick, asking Buildbucket for the build status
[15:07:15.235] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:07:15.235] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:197:0) after 1m0s
[15:08:15.342] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:197:0)
[15:08:15.342] Timer tick, asking Buildbucket for the build status
[15:08:15.456] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:08:15.456] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:198:0) after 1m0s
[15:09:15.460] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:198:0)
[15:09:15.460] Timer tick, asking Buildbucket for the build status
[15:09:15.702] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:09:15.702] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:199:0) after 1m0s
[15:10:15.827] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:199:0)
[15:10:15.827] Timer tick, asking Buildbucket for the build status
[15:10:15.953] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:10:15.953] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:200:0) after 1m0s
[15:11:15.978] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:200:0)
[15:11:15.978] Timer tick, asking Buildbucket for the build status
[15:11:16.170] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:11:16.170] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:201:0) after 1m0s
[15:12:16.270] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:201:0)
[15:12:16.270] Timer tick, asking Buildbucket for the build status
[15:12:16.367] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:12:16.367] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:202:0) after 1m0s
[15:13:16.423] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:202:0)
[15:13:16.423] Timer tick, asking Buildbucket for the build status
[15:13:16.579] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:13:16.579] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:203:0) after 1m0s
[15:14:16.661] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:203:0)
[15:14:16.662] Timer tick, asking Buildbucket for the build status
[15:14:16.854] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:14:16.854] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:204:0) after 1m0s
[15:15:16.877] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:204:0)
[15:15:16.877] Timer tick, asking Buildbucket for the build status
[15:15:16.998] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:15:16.998] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:205:0) after 1m0s
[15:16:17.154] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:205:0)
[15:16:17.155] Timer tick, asking Buildbucket for the build status
[15:16:17.251] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:16:17.251] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:206:0) after 1m0s
[15:17:17.346] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:206:0)
[15:17:17.346] Timer tick, asking Buildbucket for the build status
[15:17:17.420] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:17:17.420] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:207:0) after 1m0s
[15:18:17.664] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:207:0)
[15:18:17.664] Timer tick, asking Buildbucket for the build status
[15:18:17.948] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:18:17.948] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:208:0) after 1m0s
[15:19:18.036] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:208:0)
[15:19:18.036] Timer tick, asking Buildbucket for the build status
[15:19:18.216] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:19:18.216] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:209:0) after 1m0s
[15:20:18.314] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:209:0)
[15:20:18.314] Timer tick, asking Buildbucket for the build status
[15:20:18.847] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:20:18.848] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:210:0) after 1m0s
[15:21:18.838] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:210:0)
[15:21:18.838] Timer tick, asking Buildbucket for the build status
[15:21:19.136] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:21:19.136] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:211:0) after 1m0s
[15:22:19.194] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:211:0)
[15:22:19.194] Timer tick, asking Buildbucket for the build status
[15:22:19.337] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:22:19.337] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:212:0) after 1m0s
[15:23:19.355] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:212:0)
[15:23:19.355] Timer tick, asking Buildbucket for the build status
[15:23:19.435] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:23:19.435] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:213:0) after 1m0s
[15:24:19.477] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:213:0)
[15:24:19.477] Timer tick, asking Buildbucket for the build status
[15:24:19.565] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:24:19.565] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:214:0) after 1m0s
[15:25:19.567] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:214:0)
[15:25:19.567] Timer tick, asking Buildbucket for the build status
[15:25:19.898] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:25:19.898] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:215:0) after 1m0s
[15:26:19.930] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:215:0)
[15:26:19.930] Timer tick, asking Buildbucket for the build status
[15:26:20.032] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:26:20.032] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:216:0) after 1m0s
[15:27:20.452] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:216:0)
[15:27:20.452] Timer tick, asking Buildbucket for the build status
[15:27:20.595] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:27:20.595] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:217:0) after 1m0s
[15:28:20.759] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:217:0)
[15:28:20.759] Timer tick, asking Buildbucket for the build status
[15:28:20.909] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:28:20.909] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:218:0) after 1m0s
[15:29:21.071] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:218:0)
[15:29:21.071] Timer tick, asking Buildbucket for the build status
[15:29:21.151] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:29:21.151] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:219:0) after 1m0s
[15:30:21.290] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:219:0)
[15:30:21.290] Timer tick, asking Buildbucket for the build status
[15:30:21.547] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:30:21.547] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:220:0) after 1m0s
[15:31:21.637] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:220:0)
[15:31:21.637] Timer tick, asking Buildbucket for the build status
[15:31:21.739] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:31:21.739] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:221:0) after 1m0s
[15:32:21.826] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:221:0)
[15:32:21.826] Timer tick, asking Buildbucket for the build status
[15:32:21.924] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:32:21.924] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:222:0) after 1m0s
[15:33:22.035] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:222:0)
[15:33:22.035] Timer tick, asking Buildbucket for the build status
[15:33:22.145] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:33:22.145] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:223:0) after 1m0s
[15:34:22.230] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:223:0)
[15:34:22.230] Timer tick, asking Buildbucket for the build status
[15:34:22.304] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:34:22.304] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:224:0) after 1m0s
[15:35:22.380] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:224:0)
[15:35:22.380] Timer tick, asking Buildbucket for the build status
[15:35:22.512] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:35:22.512] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:225:0) after 1m0s
[15:36:22.591] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:225:0)
[15:36:22.591] Timer tick, asking Buildbucket for the build status
[15:36:23.307] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:36:23.307] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:226:0) after 1m0s
[15:37:23.356] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:226:0)
[15:37:23.356] Timer tick, asking Buildbucket for the build status
[15:37:23.512] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:37:23.512] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:227:0) after 1m0s
[15:38:23.514] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:227:0)
[15:38:23.514] Timer tick, asking Buildbucket for the build status
[15:38:23.630] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:38:23.630] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:228:0) after 1m0s
[15:39:23.692] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:228:0)
[15:39:23.692] Timer tick, asking Buildbucket for the build status
[15:39:23.798] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:39:23.798] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:229:0) after 1m0s
[15:40:23.819] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:229:0)
[15:40:23.819] Timer tick, asking Buildbucket for the build status
[15:40:23.925] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:40:23.925] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:230:0) after 1m0s
[15:41:23.917] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:230:0)
[15:41:23.917] Timer tick, asking Buildbucket for the build status
[15:41:24.057] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:41:24.057] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:231:0) after 1m0s
[15:42:24.044] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:231:0)
[15:42:24.044] Timer tick, asking Buildbucket for the build status
[15:42:24.130] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:42:24.130] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:232:0) after 1m0s
[15:43:24.168] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:232:0)
[15:43:24.168] Timer tick, asking Buildbucket for the build status
[15:43:24.273] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:43:24.273] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:233:0) after 1m0s
[15:44:24.298] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:233:0)
[15:44:24.298] Timer tick, asking Buildbucket for the build status
[15:44:24.551] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:44:24.551] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:234:0) after 1m0s
[15:45:24.562] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:234:0)
[15:45:24.562] Timer tick, asking Buildbucket for the build status
[15:45:24.649] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:45:24.649] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:235:0) after 1m0s
[15:46:24.753] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:235:0)
[15:46:24.753] Timer tick, asking Buildbucket for the build status
[15:46:24.935] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:46:24.935] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:236:0) after 1m0s
[15:47:25.207] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:236:0)
[15:47:25.207] Timer tick, asking Buildbucket for the build status
[15:47:25.285] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:47:25.285] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:237:0) after 1m0s
[15:48:25.487] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:237:0)
[15:48:25.487] Timer tick, asking Buildbucket for the build status
[15:48:25.636] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:48:25.636] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:238:0) after 1m0s
[15:49:25.743] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:238:0)
[15:49:25.743] Timer tick, asking Buildbucket for the build status
[15:49:25.829] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:49:25.829] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:239:0) after 1m0s
[15:50:25.898] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:239:0)
[15:50:25.898] Timer tick, asking Buildbucket for the build status
[15:50:25.983] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:50:25.983] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:240:0) after 1m0s
[15:51:26.056] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:240:0)
[15:51:26.056] Timer tick, asking Buildbucket for the build status
[15:51:26.175] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:51:26.175] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:241:0) after 1m0s
[15:52:26.235] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:241:0)
[15:52:26.235] Timer tick, asking Buildbucket for the build status
[15:52:26.594] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:52:26.594] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:242:0) after 1m0s
[15:53:26.664] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:242:0)
[15:53:26.664] Timer tick, asking Buildbucket for the build status
[15:53:26.772] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:53:26.772] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:243:0) after 1m0s
[15:54:26.822] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:243:0)
[15:54:26.822] Timer tick, asking Buildbucket for the build status
[15:54:27.151] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:54:27.151] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:244:0) after 1m0s
[15:55:27.307] Handling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:244:0)
[15:55:27.307] Timer tick, asking Buildbucket for the build status
[15:55:27.538] Build 8854597563398402416: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:55:27.538] Scheduling timer "check-buildbucket-build-status" (chromium/win32-official:9020027625519147888:245:0) after 1m0s
[15:56:13.347] Received PubSub notification, asking Buildbucket for the build status
[15:56:13.642] Build 8854597563398402416: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[15:56:13.642] Buildbucket build:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary": true,
    "canary_preference": "CANARY",
    "completed_ts": "1614009372216453",
    "created_by": "project:chromium",
    "created_ts": "1613994743881194",
    "id": "8854597563398402416",
    "parameters_json": "{\"builder_name\": \"win32-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"ecef70257810e677530925854194671d27064eeb\"}}",
    "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\": \"ecef70257810e677530925854194671d27064eeb\", \"project\": \"chromium/src\"}], \"$recipe_engine/path\": {\"cache_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\cache\", \"temp_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\tmp\\\\rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"win-dbg-1-jd57\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium\", \"buildername\": \"win32-official\", \"buildnumber\": 1592, \"got_angle_revision\": \"196de52a3670581eee89544cea89bcb57da00751\", \"got_dawn_revision\": \"1258e245a978083cab0b707c84dea814eadb3fbb\", \"got_nacl_revision\": \"abf3277f295c6c87f0b103f291ed5e3e73933b76\", \"got_revision\": \"ecef70257810e677530925854194671d27064eeb\", \"got_revision_cp\": \"refs/heads/master@{#856235}\", \"got_swarming_client_revision\": \"a32a1607f6093d338f756c7e7c7b4333b0c50c9c\", \"got_swiftshader_revision\": \"d85a7a27b27269741a779a72f33436b83d98687c\", \"got_v8_revision\": \"f604046d660441e4b22b70a6239f5c826e8a45e7\", \"got_v8_revision_cp\": \"refs/heads/9.0.231@{#1}\", \"got_webrtc_revision\": \"753c76a705199ea752933f3688a8e4c8233dca53\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#33298}\", \"mirrored_builders\": [\"tryserver.chromium:win32-official\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"ecef70257810e677530925854194671d27064eeb\"}, \"swarming\": {\"bot_dimensions\": {\"builder\": [\"win-archive-dbg\", \"win-archive-rel\", \"win-official\", \"win32-archive-dbg\", \"win32-archive-rel\", \"win32-official\"], \"caches\": [\"builder_f6b49936a2965b3cdad8f63ce13313d0c4b82119a9acfffbfe199e91c26d0c88_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"win-dbg-1-jd57\"], \"image\": [\"chrome-win10-1703-20111600-a937a23cefb\"], \"integrity\": [\"high\"], \"locale\": [\"en_US.cp1252\"], \"machine_type\": [\"e2-standard-32\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.13\"], \"server_version\": [\"5706-397711c\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-b\"]}}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1613994852529229",
    "status": "COMPLETED",
    "status_changed_ts": "1614009372730071",
    "tags": [
      "build_address:luci.chromium.ci/win32-official/1592",
      "builder:win32-official",
      "buildset:commit/git/ecef70257810e677530925854194671d27064eeb",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/ecef70257810e677530925854194671d27064eeb",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9020027625519147888",
      "scheduler_job_id:chromium/win32-official",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8854597563398402416/+/annotations",
      "swarming_tag:luci_project:chromium",
      "swarming_tag:os:Windows",
      "swarming_tag:recipe_name:chromium",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
      "swarming_task_id:51e266e51b479e10",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1614009372762135",
    "url": "https://ci.chromium.org/b/8854597563398402416",
    "utcnow_ts": "1614009373620323"
  }
}
[15:56:13.642] Invocation finished in 4h3m51.167155403s with status SUCCEEDED