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

Definition (rev 61da5958bb1bf61dc6dab9a9ab14fa46798b5d0f)

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

Incoming triggers

Incoming properties

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

Incoming tags

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

Debug log (UTC)

[11:35:36.672] New invocation is queued and will start shortly
[11:35:37.768] Starting the invocation (attempt 1)
[11:35:37.833] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[11:35:37.833] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[11:35:37.833] Buildbucket request:
{
  "bucket": "luci.chromium.ci",
  "client_operation_id": "9028907182906550912",
  "parameters_json": "{\"builder_name\":\"win-official\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"bb2045cf2bf76d4187b581dc463a1f30425a8eda\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:win-official",
    "scheduler_invocation_id:9028907182906550912",
    "scheduler_job_id:chromium/win-official",
    "user_agent:luci-scheduler",
    "buildset:commit/git/bb2045cf2bf76d4187b581dc463a1f30425a8eda",
    "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/bb2045cf2bf76d4187b581dc463a1f30425a8eda",
    "gitiles_ref:refs/heads/master"
  ]
}
[11:35:38.485] Buildbucket response:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "created_by": "project:chromium",
    "created_ts": "1605526538029485",
    "id": "8863477120817670976",
    "parameters_json": "{\"builder_name\": \"win-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"bb2045cf2bf76d4187b581dc463a1f30425a8eda\"}}",
    "project": "chromium",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1605526538379947",
    "tags": [
      "build_address:luci.chromium.ci/win-official/1029",
      "builder:win-official",
      "buildset:commit/git/bb2045cf2bf76d4187b581dc463a1f30425a8eda",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/bb2045cf2bf76d4187b581dc463a1f30425a8eda",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9028907182906550912",
      "scheduler_job_id:chromium/win-official",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8863477120817670976/+/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": "1605526538380100",
    "url": "https://ci.chromium.org/b/8863477120817670976",
    "utcnow_ts": "1605526538475284"
  }
}
[11:35:38.485] Task URL: https://ci.chromium.org/b/8863477120817670976
[11:35:38.485] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:2:0) after 1m0s
[11:36:38.484] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:2:0)
[11:36:38.484] Timer tick, asking Buildbucket for the build status
[11:36:38.679] Build 8863477120817670976: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:36:38.679] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:3:0) after 1m0s
[11:37:38.739] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:3:0)
[11:37:38.739] Timer tick, asking Buildbucket for the build status
[11:37:38.852] Build 8863477120817670976: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:37:38.852] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:4:0) after 1m0s
[11:38:38.872] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:4:0)
[11:38:38.872] Timer tick, asking Buildbucket for the build status
[11:38:38.962] Build 8863477120817670976: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:38:38.963] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:5:0) after 1m0s
[11:39:20.130] Received PubSub notification, asking Buildbucket for the build status
[11:39:20.210] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:39:39.047] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:5:0)
[11:39:39.047] Timer tick, asking Buildbucket for the build status
[11:39:39.116] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:39:39.116] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:7:0) after 1m0s
[11:40:39.136] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:7:0)
[11:40:39.136] Timer tick, asking Buildbucket for the build status
[11:40:39.256] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:40:39.256] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:8:0) after 1m0s
[11:41:39.310] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:8:0)
[11:41:39.310] Timer tick, asking Buildbucket for the build status
[11:41:39.390] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:41:39.390] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:9:0) after 1m0s
[11:42:39.477] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:9:0)
[11:42:39.477] Timer tick, asking Buildbucket for the build status
[11:42:39.667] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:42:39.667] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:10:0) after 1m0s
[11:43:39.662] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:10:0)
[11:43:39.662] Timer tick, asking Buildbucket for the build status
[11:43:39.742] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:43:39.742] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:11:0) after 1m0s
[11:44:39.779] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:11:0)
[11:44:39.779] Timer tick, asking Buildbucket for the build status
[11:44:40.118] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:44:40.118] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:12:0) after 1m0s
[11:45:40.167] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:12:0)
[11:45:40.167] Timer tick, asking Buildbucket for the build status
[11:45:40.752] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:45:40.752] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:13:0) after 1m0s
[11:46:40.782] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:13:0)
[11:46:40.782] Timer tick, asking Buildbucket for the build status
[11:46:40.861] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:46:40.862] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:14:0) after 1m0s
[11:47:40.893] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:14:0)
[11:47:40.893] Timer tick, asking Buildbucket for the build status
[11:47:40.983] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:47:40.983] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:15:0) after 1m0s
[11:48:41.066] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:15:0)
[11:48:41.066] Timer tick, asking Buildbucket for the build status
[11:48:41.419] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:48:41.420] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:16:0) after 1m0s
[11:49:41.433] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:16:0)
[11:49:41.433] Timer tick, asking Buildbucket for the build status
[11:49:41.504] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:49:41.504] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:17:0) after 1m0s
[11:50:41.543] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:17:0)
[11:50:41.543] Timer tick, asking Buildbucket for the build status
[11:50:41.644] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:50:41.644] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:18:0) after 1m0s
[11:51:41.658] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:18:0)
[11:51:41.658] Timer tick, asking Buildbucket for the build status
[11:51:41.722] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:51:41.722] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:19:0) after 1m0s
[11:52:41.821] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:19:0)
[11:52:41.821] Timer tick, asking Buildbucket for the build status
[11:52:41.897] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:52:41.898] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:20:0) after 1m0s
[11:53:41.926] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:20:0)
[11:53:41.926] Timer tick, asking Buildbucket for the build status
[11:53:41.990] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:53:41.990] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:21:0) after 1m0s
[11:54:42.112] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:21:0)
[11:54:42.112] Timer tick, asking Buildbucket for the build status
[11:54:42.224] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:54:42.224] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:22:0) after 1m0s
[11:55:42.272] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:22:0)
[11:55:42.272] Timer tick, asking Buildbucket for the build status
[11:55:42.366] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:55:42.367] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:23:0) after 1m0s
[11:56:42.469] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:23:0)
[11:56:42.469] Timer tick, asking Buildbucket for the build status
[11:56:42.554] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:56:42.554] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:24:0) after 1m0s
[11:57:42.540] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:24:0)
[11:57:42.540] Timer tick, asking Buildbucket for the build status
[11:57:42.620] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:57:42.620] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:25:0) after 1m0s
[11:58:42.641] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:25:0)
[11:58:42.641] Timer tick, asking Buildbucket for the build status
[11:58:42.849] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:58:42.849] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:26:0) after 1m0s
[11:59:42.904] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:26:0)
[11:59:42.904] Timer tick, asking Buildbucket for the build status
[11:59:42.995] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:59:42.995] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:27:0) after 1m0s
[12:00:42.988] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:27:0)
[12:00:42.988] Timer tick, asking Buildbucket for the build status
[12:00:43.661] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:00:43.661] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:28:0) after 1m0s
[12:01:43.720] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:28:0)
[12:01:43.720] Timer tick, asking Buildbucket for the build status
[12:01:43.976] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:01:43.976] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:29:0) after 1m0s
[12:02:44.056] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:29:0)
[12:02:44.056] Timer tick, asking Buildbucket for the build status
[12:02:44.169] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:02:44.169] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:30:0) after 1m0s
[12:03:44.188] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:30:0)
[12:03:44.188] Timer tick, asking Buildbucket for the build status
[12:03:44.246] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:03:44.246] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:31:0) after 1m0s
[12:04:44.316] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:31:0)
[12:04:44.316] Timer tick, asking Buildbucket for the build status
[12:04:44.444] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:04:44.444] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:32:0) after 1m0s
[12:05:44.496] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:32:0)
[12:05:44.496] Timer tick, asking Buildbucket for the build status
[12:05:44.605] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:05:44.605] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:33:0) after 1m0s
[12:06:44.653] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:33:0)
[12:06:44.653] Timer tick, asking Buildbucket for the build status
[12:06:44.818] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:06:44.818] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:34:0) after 1m0s
[12:07:44.852] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:34:0)
[12:07:44.852] Timer tick, asking Buildbucket for the build status
[12:07:45.118] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:07:45.118] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:35:0) after 1m0s
[12:08:45.151] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:35:0)
[12:08:45.151] Timer tick, asking Buildbucket for the build status
[12:08:45.337] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:08:45.337] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:36:0) after 1m0s
[12:09:45.345] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:36:0)
[12:09:45.345] Timer tick, asking Buildbucket for the build status
[12:09:45.448] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:09:45.448] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:37:0) after 1m0s
[12:10:45.474] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:37:0)
[12:10:45.474] Timer tick, asking Buildbucket for the build status
[12:10:45.635] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:10:45.635] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:38:0) after 1m0s
[12:11:45.701] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:38:0)
[12:11:45.701] Timer tick, asking Buildbucket for the build status
[12:11:45.767] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:11:45.767] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:39:0) after 1m0s
[12:12:45.898] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:39:0)
[12:12:45.898] Timer tick, asking Buildbucket for the build status
[12:12:46.080] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:12:46.080] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:40:0) after 1m0s
[12:13:46.221] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:40:0)
[12:13:46.221] Timer tick, asking Buildbucket for the build status
[12:13:46.371] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:13:46.371] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:41:0) after 1m0s
[12:14:46.481] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:41:0)
[12:14:46.481] Timer tick, asking Buildbucket for the build status
[12:14:46.648] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:14:46.648] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:42:0) after 1m0s
[12:15:46.851] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:42:0)
[12:15:46.851] Timer tick, asking Buildbucket for the build status
[12:15:46.958] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:15:46.958] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:43:0) after 1m0s
[12:16:47.054] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:43:0)
[12:16:47.054] Timer tick, asking Buildbucket for the build status
[12:16:47.123] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:16:47.123] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:44:0) after 1m0s
[12:17:47.397] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:44:0)
[12:17:47.397] Timer tick, asking Buildbucket for the build status
[12:17:47.488] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:17:47.488] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:45:0) after 1m0s
[12:18:47.920] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:45:0)
[12:18:47.920] Timer tick, asking Buildbucket for the build status
[12:18:47.999] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:18:47.999] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:46:0) after 1m0s
[12:19:48.184] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:46:0)
[12:19:48.184] Timer tick, asking Buildbucket for the build status
[12:19:48.240] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:19:48.240] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:47:0) after 1m0s
[12:20:48.299] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:47:0)
[12:20:48.299] Timer tick, asking Buildbucket for the build status
[12:20:48.393] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:20:48.393] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:48:0) after 1m0s
[12:21:48.668] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:48:0)
[12:21:48.668] Timer tick, asking Buildbucket for the build status
[12:21:48.892] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:21:48.892] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:49:0) after 1m0s
[12:22:49.036] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:49:0)
[12:22:49.036] Timer tick, asking Buildbucket for the build status
[12:22:49.263] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:22:49.263] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:50:0) after 1m0s
[12:23:49.496] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:50:0)
[12:23:49.496] Timer tick, asking Buildbucket for the build status
[12:23:49.688] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:23:49.688] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:51:0) after 1m0s
[12:24:49.742] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:51:0)
[12:24:49.742] Timer tick, asking Buildbucket for the build status
[12:24:49.809] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:24:49.809] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:52:0) after 1m0s
[12:25:50.074] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:52:0)
[12:25:50.074] Timer tick, asking Buildbucket for the build status
[12:25:50.196] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:25:50.196] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:53:0) after 1m0s
[12:26:50.346] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:53:0)
[12:26:50.346] Timer tick, asking Buildbucket for the build status
[12:26:50.409] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:26:50.409] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:54:0) after 1m0s
[12:27:50.611] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:54:0)
[12:27:50.611] Timer tick, asking Buildbucket for the build status
[12:27:50.737] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:27:50.737] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:55:0) after 1m0s
[12:28:50.862] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:55:0)
[12:28:50.862] Timer tick, asking Buildbucket for the build status
[12:28:50.919] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:28:50.919] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:56:0) after 1m0s
[12:29:50.990] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:56:0)
[12:29:50.990] Timer tick, asking Buildbucket for the build status
[12:29:51.060] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:29:51.060] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:57:0) after 1m0s
[12:30:51.256] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:57:0)
[12:30:51.256] Timer tick, asking Buildbucket for the build status
[12:30:51.388] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:30:51.388] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:58:0) after 1m0s
[12:31:51.656] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:58:0)
[12:31:51.656] Timer tick, asking Buildbucket for the build status
[12:31:51.717] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:31:51.717] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:59:0) after 1m0s
[12:32:51.804] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:59:0)
[12:32:51.804] Timer tick, asking Buildbucket for the build status
[12:32:51.869] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:32:51.869] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:60:0) after 1m0s
[12:33:51.919] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:60:0)
[12:33:51.919] Timer tick, asking Buildbucket for the build status
[12:33:51.993] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:33:51.993] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:61:0) after 1m0s
[12:34:52.085] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:61:0)
[12:34:52.085] Timer tick, asking Buildbucket for the build status
[12:34:52.174] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:34:52.174] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:62:0) after 1m0s
[12:35:52.248] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:62:0)
[12:35:52.248] Timer tick, asking Buildbucket for the build status
[12:35:52.372] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:35:52.372] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:63:0) after 1m0s
[12:36:52.571] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:63:0)
[12:36:52.571] Timer tick, asking Buildbucket for the build status
[12:36:52.687] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:36:52.687] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:64:0) after 1m0s
[12:37:52.811] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:64:0)
[12:37:52.811] Timer tick, asking Buildbucket for the build status
[12:37:52.892] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:37:52.892] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:65:0) after 1m0s
[12:38:52.964] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:65:0)
[12:38:52.964] Timer tick, asking Buildbucket for the build status
[12:38:53.039] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:38:53.039] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:66:0) after 1m0s
[12:39:53.101] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:66:0)
[12:39:53.101] Timer tick, asking Buildbucket for the build status
[12:39:53.243] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:39:53.243] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:67:0) after 1m0s
[12:40:53.485] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:67:0)
[12:40:53.485] Timer tick, asking Buildbucket for the build status
[12:40:53.629] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:40:53.629] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:68:0) after 1m0s
[12:41:54.012] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:68:0)
[12:41:54.012] Timer tick, asking Buildbucket for the build status
[12:41:54.083] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:41:54.083] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:69:0) after 1m0s
[12:42:54.380] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:69:0)
[12:42:54.380] Timer tick, asking Buildbucket for the build status
[12:42:54.445] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:42:54.445] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:70:0) after 1m0s
[12:43:54.573] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:70:0)
[12:43:54.573] Timer tick, asking Buildbucket for the build status
[12:43:54.967] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:43:54.967] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:71:0) after 1m0s
[12:44:55.112] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:71:0)
[12:44:55.112] Timer tick, asking Buildbucket for the build status
[12:44:55.193] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:44:55.193] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:72:0) after 1m0s
[12:45:55.682] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:72:0)
[12:45:55.682] Timer tick, asking Buildbucket for the build status
[12:45:56.020] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:45:56.020] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:73:0) after 1m0s
[12:46:56.043] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:73:0)
[12:46:56.043] Timer tick, asking Buildbucket for the build status
[12:46:56.252] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:46:56.252] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:74:0) after 1m0s
[12:47:56.295] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:74:0)
[12:47:56.295] Timer tick, asking Buildbucket for the build status
[12:47:56.357] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:47:56.357] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:75:0) after 1m0s
[12:48:56.424] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:75:0)
[12:48:56.424] Timer tick, asking Buildbucket for the build status
[12:48:56.499] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:48:56.499] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:76:0) after 1m0s
[12:49:56.650] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:76:0)
[12:49:56.650] Timer tick, asking Buildbucket for the build status
[12:49:56.720] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:49:56.720] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:77:0) after 1m0s
[12:50:56.860] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:77:0)
[12:50:56.860] Timer tick, asking Buildbucket for the build status
[12:50:56.982] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:50:56.982] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:78:0) after 1m0s
[12:51:57.075] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:78:0)
[12:51:57.075] Timer tick, asking Buildbucket for the build status
[12:51:57.139] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:51:57.139] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:79:0) after 1m0s
[12:52:57.195] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:79:0)
[12:52:57.195] Timer tick, asking Buildbucket for the build status
[12:52:57.275] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:52:57.275] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:80:0) after 1m0s
[12:53:57.441] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:80:0)
[12:53:57.441] Timer tick, asking Buildbucket for the build status
[12:53:57.500] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:53:57.500] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:81:0) after 1m0s
[12:54:57.623] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:81:0)
[12:54:57.623] Timer tick, asking Buildbucket for the build status
[12:54:57.682] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:54:57.682] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:82:0) after 1m0s
[12:55:57.778] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:82:0)
[12:55:57.778] Timer tick, asking Buildbucket for the build status
[12:55:57.875] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:55:57.875] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:83:0) after 1m0s
[12:56:58.055] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:83:0)
[12:56:58.055] Timer tick, asking Buildbucket for the build status
[12:56:58.125] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:56:58.125] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:84:0) after 1m0s
[12:57:59.057] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:84:0)
[12:57:59.057] Timer tick, asking Buildbucket for the build status
[12:57:59.216] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:57:59.216] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:85:0) after 1m0s
[12:58:59.322] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:85:0)
[12:58:59.322] Timer tick, asking Buildbucket for the build status
[12:58:59.418] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:58:59.418] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:86:0) after 1m0s
[12:59:59.553] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:86:0)
[12:59:59.553] Timer tick, asking Buildbucket for the build status
[12:59:59.834] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[12:59:59.834] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:87:0) after 1m0s
[13:00:59.908] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:87:0)
[13:00:59.908] Timer tick, asking Buildbucket for the build status
[13:01:00.206] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:01:00.206] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:88:0) after 1m0s
[13:02:00.331] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:88:0)
[13:02:00.331] Timer tick, asking Buildbucket for the build status
[13:02:00.408] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:02:00.408] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:89:0) after 1m0s
[13:03:00.459] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:89:0)
[13:03:00.459] Timer tick, asking Buildbucket for the build status
[13:03:00.554] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:03:00.554] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:90:0) after 1m0s
[13:04:02.322] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:90:0)
[13:04:02.322] Timer tick, asking Buildbucket for the build status
[13:04:02.653] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:04:02.653] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:91:0) after 1m0s
[13:05:03.065] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:91:0)
[13:05:03.065] Timer tick, asking Buildbucket for the build status
[13:05:03.155] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:05:03.155] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:92:0) after 1m0s
[13:06:03.495] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:92:0)
[13:06:03.495] Timer tick, asking Buildbucket for the build status
[13:06:03.620] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:06:03.620] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:93:0) after 1m0s
[13:07:03.779] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:93:0)
[13:07:03.779] Timer tick, asking Buildbucket for the build status
[13:07:04.027] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:07:04.027] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:94:0) after 1m0s
[13:08:04.317] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:94:0)
[13:08:04.317] Timer tick, asking Buildbucket for the build status
[13:08:04.403] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:08:04.403] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:95:0) after 1m0s
[13:09:04.504] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:95:0)
[13:09:04.504] Timer tick, asking Buildbucket for the build status
[13:09:04.742] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:09:04.743] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:96:0) after 1m0s
[13:10:04.952] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:96:0)
[13:10:04.952] Timer tick, asking Buildbucket for the build status
[13:10:05.033] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:10:05.033] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:97:0) after 1m0s
[13:11:05.348] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:97:0)
[13:11:05.348] Timer tick, asking Buildbucket for the build status
[13:11:05.460] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:11:05.460] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:98:0) after 1m0s
[13:12:05.589] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:98:0)
[13:12:05.589] Timer tick, asking Buildbucket for the build status
[13:12:05.659] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:12:05.659] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:99:0) after 1m0s
[13:13:05.789] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:99:0)
[13:13:05.789] Timer tick, asking Buildbucket for the build status
[13:13:05.935] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:13:05.935] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:100:0) after 1m0s
[13:14:05.965] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:100:0)
[13:14:05.965] Timer tick, asking Buildbucket for the build status
[13:14:06.241] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:14:06.241] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:101:0) after 1m0s
[13:15:06.321] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:101:0)
[13:15:06.321] Timer tick, asking Buildbucket for the build status
[13:15:06.404] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:15:06.404] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:102:0) after 1m0s
[13:16:06.512] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:102:0)
[13:16:06.512] Timer tick, asking Buildbucket for the build status
[13:16:06.879] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:16:06.879] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:103:0) after 1m0s
[13:17:07.017] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:103:0)
[13:17:07.017] Timer tick, asking Buildbucket for the build status
[13:17:07.089] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:17:07.089] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:104:0) after 1m0s
[13:18:07.208] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:104:0)
[13:18:07.208] Timer tick, asking Buildbucket for the build status
[13:18:07.428] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:18:07.428] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:105:0) after 1m0s
[13:19:07.491] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:105:0)
[13:19:07.491] Timer tick, asking Buildbucket for the build status
[13:19:07.555] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:19:07.555] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:106:0) after 1m0s
[13:20:07.731] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:106:0)
[13:20:07.731] Timer tick, asking Buildbucket for the build status
[13:20:07.820] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:20:07.820] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:107:0) after 1m0s
[13:21:07.893] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:107:0)
[13:21:07.893] Timer tick, asking Buildbucket for the build status
[13:21:08.391] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:21:08.391] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:108:0) after 1m0s
[13:22:08.450] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:108:0)
[13:22:08.450] Timer tick, asking Buildbucket for the build status
[13:22:08.549] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:22:08.549] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:109:0) after 1m0s
[13:23:08.671] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:109:0)
[13:23:08.671] Timer tick, asking Buildbucket for the build status
[13:23:08.861] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:23:08.861] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:110:0) after 1m0s
[13:24:08.899] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:110:0)
[13:24:08.899] Timer tick, asking Buildbucket for the build status
[13:24:08.973] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:24:08.973] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:111:0) after 1m0s
[13:25:09.021] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:111:0)
[13:25:09.021] Timer tick, asking Buildbucket for the build status
[13:25:09.105] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:25:09.105] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:112:0) after 1m0s
[13:26:09.134] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:112:0)
[13:26:09.134] Timer tick, asking Buildbucket for the build status
[13:26:09.243] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:26:09.243] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:113:0) after 1m0s
[13:27:09.269] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:113:0)
[13:27:09.269] Timer tick, asking Buildbucket for the build status
[13:27:09.502] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:27:09.502] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:114:0) after 1m0s
[13:28:09.563] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:114:0)
[13:28:09.563] Timer tick, asking Buildbucket for the build status
[13:28:09.627] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:28:09.627] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:115:0) after 1m0s
[13:29:09.669] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:115:0)
[13:29:09.669] Timer tick, asking Buildbucket for the build status
[13:29:09.778] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:29:09.778] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:116:0) after 1m0s
[13:30:09.889] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:116:0)
[13:30:09.889] Timer tick, asking Buildbucket for the build status
[13:30:09.970] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:30:09.970] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:117:0) after 1m0s
[13:31:10.108] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:117:0)
[13:31:10.108] Timer tick, asking Buildbucket for the build status
[13:31:10.226] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:31:10.226] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:118:0) after 1m0s
[13:32:10.272] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:118:0)
[13:32:10.273] Timer tick, asking Buildbucket for the build status
[13:32:10.340] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:32:10.340] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:119:0) after 1m0s
[13:33:10.403] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:119:0)
[13:33:10.403] Timer tick, asking Buildbucket for the build status
[13:33:10.635] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:33:10.635] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:120:0) after 1m0s
[13:34:10.665] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:120:0)
[13:34:10.665] Timer tick, asking Buildbucket for the build status
[13:34:10.815] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:34:10.815] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:121:0) after 1m0s
[13:35:10.879] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:121:0)
[13:35:10.879] Timer tick, asking Buildbucket for the build status
[13:35:10.936] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:35:10.936] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:122:0) after 1m0s
[13:36:11.043] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:122:0)
[13:36:11.043] Timer tick, asking Buildbucket for the build status
[13:36:11.259] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:36:11.259] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:123:0) after 1m0s
[13:37:11.305] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:123:0)
[13:37:11.305] Timer tick, asking Buildbucket for the build status
[13:37:11.376] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:37:11.376] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:124:0) after 1m0s
[13:38:11.424] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:124:0)
[13:38:11.424] Timer tick, asking Buildbucket for the build status
[13:38:11.505] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:38:11.505] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:125:0) after 1m0s
[13:39:11.626] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:125:0)
[13:39:11.626] Timer tick, asking Buildbucket for the build status
[13:39:11.896] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:39:11.896] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:126:0) after 1m0s
[13:40:11.940] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:126:0)
[13:40:11.940] Timer tick, asking Buildbucket for the build status
[13:40:12.072] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:40:12.072] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:127:0) after 1m0s
[13:41:12.100] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:127:0)
[13:41:12.100] Timer tick, asking Buildbucket for the build status
[13:41:12.304] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:41:12.304] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:128:0) after 1m0s
[13:42:12.378] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:128:0)
[13:42:12.378] Timer tick, asking Buildbucket for the build status
[13:42:12.443] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:42:12.443] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:129:0) after 1m0s
[13:43:12.478] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:129:0)
[13:43:12.478] Timer tick, asking Buildbucket for the build status
[13:43:12.553] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:43:12.553] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:130:0) after 1m0s
[13:44:12.615] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:130:0)
[13:44:12.615] Timer tick, asking Buildbucket for the build status
[13:44:12.904] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:44:12.904] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:131:0) after 1m0s
[13:45:13.265] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:131:0)
[13:45:13.265] Timer tick, asking Buildbucket for the build status
[13:45:13.337] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:45:13.337] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:132:0) after 1m0s
[13:46:13.613] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:132:0)
[13:46:13.613] Timer tick, asking Buildbucket for the build status
[13:46:13.722] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:46:13.722] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:133:0) after 1m0s
[13:47:13.926] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:133:0)
[13:47:13.926] Timer tick, asking Buildbucket for the build status
[13:47:14.021] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:47:14.021] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:134:0) after 1m0s
[13:48:14.367] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:134:0)
[13:48:14.367] Timer tick, asking Buildbucket for the build status
[13:48:14.437] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:48:14.437] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:135:0) after 1m0s
[13:49:14.594] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:135:0)
[13:49:14.594] Timer tick, asking Buildbucket for the build status
[13:49:14.760] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:49:14.760] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:136:0) after 1m0s
[13:50:14.963] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:136:0)
[13:50:14.963] Timer tick, asking Buildbucket for the build status
[13:50:15.162] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:50:15.162] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:137:0) after 1m0s
[13:51:17.396] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:137:0)
[13:51:17.396] Timer tick, asking Buildbucket for the build status
[13:51:17.625] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:51:17.625] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:138:0) after 1m0s
[13:52:17.735] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:138:0)
[13:52:17.735] Timer tick, asking Buildbucket for the build status
[13:52:17.801] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:52:17.801] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:139:0) after 1m0s
[13:53:17.973] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:139:0)
[13:53:17.973] Timer tick, asking Buildbucket for the build status
[13:53:18.123] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:53:18.123] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:140:0) after 1m0s
[13:54:18.189] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:140:0)
[13:54:18.189] Timer tick, asking Buildbucket for the build status
[13:54:18.318] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:54:18.318] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:141:0) after 1m0s
[13:55:18.369] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:141:0)
[13:55:18.369] Timer tick, asking Buildbucket for the build status
[13:55:18.429] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:55:18.429] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:142:0) after 1m0s
[13:56:18.479] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:142:0)
[13:56:18.479] Timer tick, asking Buildbucket for the build status
[13:56:18.693] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:56:18.693] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:143:0) after 1m0s
[13:57:18.764] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:143:0)
[13:57:18.764] Timer tick, asking Buildbucket for the build status
[13:57:18.837] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:57:18.837] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:144:0) after 1m0s
[13:58:19.022] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:144:0)
[13:58:19.022] Timer tick, asking Buildbucket for the build status
[13:58:19.122] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:58:19.122] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:145:0) after 1m0s
[13:59:19.318] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:145:0)
[13:59:19.318] Timer tick, asking Buildbucket for the build status
[13:59:19.407] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:59:19.407] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:146:0) after 1m0s
[14:00:19.515] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:146:0)
[14:00:19.515] Timer tick, asking Buildbucket for the build status
[14:00:19.672] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:00:19.672] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:147:0) after 1m0s
[14:01:19.732] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:147:0)
[14:01:19.732] Timer tick, asking Buildbucket for the build status
[14:01:19.835] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:01:19.835] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:148:0) after 1m0s
[14:02:20.012] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:148:0)
[14:02:20.012] Timer tick, asking Buildbucket for the build status
[14:02:20.181] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:02:20.181] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:149:0) after 1m0s
[14:03:20.318] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:149:0)
[14:03:20.318] Timer tick, asking Buildbucket for the build status
[14:03:20.725] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:03:20.726] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:150:0) after 1m0s
[14:04:21.043] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:150:0)
[14:04:21.043] Timer tick, asking Buildbucket for the build status
[14:04:21.145] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:04:21.145] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:151:0) after 1m0s
[14:05:21.185] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:151:0)
[14:05:21.185] Timer tick, asking Buildbucket for the build status
[14:05:21.261] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:05:21.261] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:152:0) after 1m0s
[14:06:21.339] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:152:0)
[14:06:21.339] Timer tick, asking Buildbucket for the build status
[14:06:21.602] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:21.602] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:153:0) after 1m0s
[14:07:21.791] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:153:0)
[14:07:21.791] Timer tick, asking Buildbucket for the build status
[14:07:21.976] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:07:21.976] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:154:0) after 1m0s
[14:08:22.066] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:154:0)
[14:08:22.066] Timer tick, asking Buildbucket for the build status
[14:08:22.126] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:08:22.126] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:155:0) after 1m0s
[14:09:22.184] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:155:0)
[14:09:22.184] Timer tick, asking Buildbucket for the build status
[14:09:22.708] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:09:22.708] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:156:0) after 1m0s
[14:10:22.802] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:156:0)
[14:10:22.802] Timer tick, asking Buildbucket for the build status
[14:10:23.307] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:23.307] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:157:0) after 1m0s
[14:11:23.373] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:157:0)
[14:11:23.373] Timer tick, asking Buildbucket for the build status
[14:11:23.485] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:23.485] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:158:0) after 1m0s
[14:12:23.590] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:158:0)
[14:12:23.590] Timer tick, asking Buildbucket for the build status
[14:12:23.660] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:23.660] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:159:0) after 1m0s
[14:13:23.724] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:159:0)
[14:13:23.724] Timer tick, asking Buildbucket for the build status
[14:13:23.920] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:23.920] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:160:0) after 1m0s
[14:14:24.959] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:160:0)
[14:14:24.959] Timer tick, asking Buildbucket for the build status
[14:14:25.031] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:25.031] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:161:0) after 1m0s
[14:15:25.256] Handling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:161:0)
[14:15:25.256] Timer tick, asking Buildbucket for the build status
[14:15:25.310] Build 8863477120817670976: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:25.310] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9028907182906550912:162:0) after 1m0s
[14:16:19.605] Received PubSub notification, asking Buildbucket for the build status
[14:16:19.669] Build 8863477120817670976: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[14:16:19.669] Buildbucket build:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "completed_ts": "1605536176956113",
    "created_by": "project:chromium",
    "created_ts": "1605526538029485",
    "id": "8863477120817670976",
    "parameters_json": "{\"builder_name\": \"win-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"bb2045cf2bf76d4187b581dc463a1f30425a8eda\"}}",
    "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\": \"bb2045cf2bf76d4187b581dc463a1f30425a8eda\", \"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-4-6jth\", \"branch\": \"refs/heads/master\", \"builder_group\": \"chromium\", \"buildername\": \"win-official\", \"buildnumber\": 1029, \"got_angle_revision\": \"f46e6201b40bdee3e0b79d5d97660fc302fd76f5\", \"got_dawn_revision\": \"575729e8dd25e0ac4631c9739a82118ea3545c6b\", \"got_nacl_revision\": \"f9e6f257d1a0934dbeed3c5c8f83b651dc4f55e1\", \"got_revision\": \"bb2045cf2bf76d4187b581dc463a1f30425a8eda\", \"got_revision_cp\": \"refs/heads/master@{#827746}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"e4c1a25cc6797a47043fc415c53b8edcd7b3e37e\", \"got_v8_revision\": \"2dbcdc105b963ee2501c82139eef7e0603977ff0\", \"got_v8_revision_cp\": \"refs/heads/8.8.278@{#1}\", \"got_webrtc_revision\": \"99df1af2aed6a8d10bc62dc348f63d6c084c1949\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32609}\", \"mirrored_builders\": [\"tryserver.chromium:win-official\"], \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"bb2045cf2bf76d4187b581dc463a1f30425a8eda\"}, \"swarming\": {\"bot_dimensions\": {\"builder\": [\"win-archive-dbg\", \"win-archive-rel\", \"win-official\", \"win32-archive-dbg\", \"win32-archive-rel\", \"win32-official\"], \"caches\": [\"builder_9b3ebe5fd1c5be87380c40d216747346a59b28cf26de183f0e8e2b32e944d3c8_v2\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"win-dbg-4-6jth\"], \"image\": [\"chrome-win10-1703-20092300-22ba5320847\"], \"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\": [\"5632-2e614e1\"], \"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": "1605526758591425",
    "status": "COMPLETED",
    "status_changed_ts": "1605536177373347",
    "tags": [
      "build_address:luci.chromium.ci/win-official/1029",
      "builder:win-official",
      "buildset:commit/git/bb2045cf2bf76d4187b581dc463a1f30425a8eda",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/bb2045cf2bf76d4187b581dc463a1f30425a8eda",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9028907182906550912",
      "scheduler_job_id:chromium/win-official",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8863477120817670976/+/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:4fe9a85193c6b210",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1605536177390676",
    "url": "https://ci.chromium.org/b/8863477120817670976",
    "utcnow_ts": "1605536179661605"
  }
}
[14:16:19.669] Invocation finished in 2h40m43.014266793s with status SUCCEEDED