Status: SUCCEEDED
Triggered by: -
Duration: 3 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": "c7e728612fc890720eda3b6c72fcc1e37249a72e"
}

Incoming tags

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

Debug log (UTC)

[04:10:49.245] New invocation is queued and will start shortly
[04:10:50.323] Starting the invocation (attempt 1)
[04:10:50.365] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[04:10:50.365] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[04:10:50.365] Buildbucket request:
{
  "bucket": "luci.chromium.ci",
  "client_operation_id": "9038357251206928176",
  "parameters_json": "{\"builder_name\":\"win-official\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"c7e728612fc890720eda3b6c72fcc1e37249a72e\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:win-official",
    "scheduler_invocation_id:9038357251206928176",
    "scheduler_job_id:chromium/win-official",
    "user_agent:luci-scheduler",
    "buildset:commit/git/c7e728612fc890720eda3b6c72fcc1e37249a72e",
    "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/c7e728612fc890720eda3b6c72fcc1e37249a72e",
    "gitiles_ref:refs/heads/master"
  ]
}
[04:10:52.459] Buildbucket response:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "created_by": "project:chromium",
    "created_ts": "1596514250514532",
    "id": "8872927189210778992",
    "parameters_json": "{\"builder_name\": \"win-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"c7e728612fc890720eda3b6c72fcc1e37249a72e\"}}",
    "project": "chromium",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1596514251966309",
    "tags": [
      "build_address:luci.chromium.ci/win-official/249",
      "builder:win-official",
      "buildset:commit/git/c7e728612fc890720eda3b6c72fcc1e37249a72e",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/c7e728612fc890720eda3b6c72fcc1e37249a72e",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9038357251206928176",
      "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/8872927189210778992/+/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": "1596514251966479",
    "url": "https://ci.chromium.org/b/8872927189210778992",
    "utcnow_ts": "1596514252438180"
  }
}
[04:10:52.459] Task URL: https://ci.chromium.org/b/8872927189210778992
[04:10:52.459] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:2:0) after 1m0s
[04:11:52.432] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:2:0)
[04:11:52.432] Timer tick, asking Buildbucket for the build status
[04:11:52.622] Build 8872927189210778992: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:11:52.622] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:3:0) after 1m0s
[04:12:52.652] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:3:0)
[04:12:52.652] Timer tick, asking Buildbucket for the build status
[04:12:53.068] Build 8872927189210778992: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:12:53.068] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:4:0) after 1m0s
[04:13:21.929] Received PubSub notification, asking Buildbucket for the build status
[04:13:22.464] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:13:53.135] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:4:0)
[04:13:53.135] Timer tick, asking Buildbucket for the build status
[04:13:53.277] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:13:53.277] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:6:0) after 1m0s
[04:14:53.336] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:6:0)
[04:14:53.336] Timer tick, asking Buildbucket for the build status
[04:14:53.434] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:14:53.434] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:7:0) after 1m0s
[04:15:53.624] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:7:0)
[04:15:53.624] Timer tick, asking Buildbucket for the build status
[04:15:53.828] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:15:53.828] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:8:0) after 1m0s
[04:16:53.856] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:8:0)
[04:16:53.856] Timer tick, asking Buildbucket for the build status
[04:16:53.988] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:16:53.989] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:9:0) after 1m0s
[04:17:54.050] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:9:0)
[04:17:54.050] Timer tick, asking Buildbucket for the build status
[04:17:54.374] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:17:54.374] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:10:0) after 1m0s
[04:18:54.457] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:10:0)
[04:18:54.457] Timer tick, asking Buildbucket for the build status
[04:18:54.828] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:18:54.828] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:11:0) after 1m0s
[04:19:54.921] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:11:0)
[04:19:54.921] Timer tick, asking Buildbucket for the build status
[04:19:55.015] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:19:55.015] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:12:0) after 1m0s
[04:20:55.041] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:12:0)
[04:20:55.041] Timer tick, asking Buildbucket for the build status
[04:20:55.221] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:20:55.221] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:13:0) after 1m0s
[04:21:55.276] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:13:0)
[04:21:55.276] Timer tick, asking Buildbucket for the build status
[04:21:55.697] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:21:55.697] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:14:0) after 1m0s
[04:22:55.721] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:14:0)
[04:22:55.721] Timer tick, asking Buildbucket for the build status
[04:22:55.967] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:22:55.967] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:15:0) after 1m0s
[04:23:56.000] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:15:0)
[04:23:56.000] Timer tick, asking Buildbucket for the build status
[04:23:56.225] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:23:56.225] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:16:0) after 1m0s
[04:24:56.250] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:16:0)
[04:24:56.250] Timer tick, asking Buildbucket for the build status
[04:24:58.408] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:24:58.408] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:17:0) after 1m0s
[04:25:58.427] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:17:0)
[04:25:58.427] Timer tick, asking Buildbucket for the build status
[04:25:58.988] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:25:58.988] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:18:0) after 1m0s
[04:26:59.052] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:18:0)
[04:26:59.052] Timer tick, asking Buildbucket for the build status
[04:26:59.203] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:26:59.203] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:19:0) after 1m0s
[04:27:59.228] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:19:0)
[04:27:59.228] Timer tick, asking Buildbucket for the build status
[04:27:59.438] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:27:59.438] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:20:0) after 1m0s
[04:28:59.451] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:20:0)
[04:28:59.451] Timer tick, asking Buildbucket for the build status
[04:28:59.551] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:28:59.551] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:21:0) after 1m0s
[04:29:59.572] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:21:0)
[04:29:59.572] Timer tick, asking Buildbucket for the build status
[04:29:59.711] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:29:59.711] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:22:0) after 1m0s
[04:30:59.785] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:22:0)
[04:30:59.785] Timer tick, asking Buildbucket for the build status
[04:31:00.162] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:31:00.163] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:23:0) after 1m0s
[04:32:00.466] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:23:0)
[04:32:00.466] Timer tick, asking Buildbucket for the build status
[04:32:00.549] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:32:00.549] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:24:0) after 1m0s
[04:33:00.545] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:24:0)
[04:33:00.545] Timer tick, asking Buildbucket for the build status
[04:33:00.642] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:33:00.642] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:25:0) after 1m0s
[04:34:00.726] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:25:0)
[04:34:00.726] Timer tick, asking Buildbucket for the build status
[04:34:00.844] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:34:00.844] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:26:0) after 1m0s
[04:35:01.472] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:26:0)
[04:35:01.472] Timer tick, asking Buildbucket for the build status
[04:35:01.643] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:35:01.643] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:27:0) after 1m0s
[04:36:01.753] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:27:0)
[04:36:01.753] Timer tick, asking Buildbucket for the build status
[04:36:02.253] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:36:02.253] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:28:0) after 1m0s
[04:37:02.370] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:28:0)
[04:37:02.370] Timer tick, asking Buildbucket for the build status
[04:37:02.519] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:37:02.519] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:29:0) after 1m0s
[04:38:02.575] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:29:0)
[04:38:02.575] Timer tick, asking Buildbucket for the build status
[04:38:02.734] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:38:02.734] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:30:0) after 1m0s
[04:39:02.812] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:30:0)
[04:39:02.812] Timer tick, asking Buildbucket for the build status
[04:39:03.437] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:39:03.437] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:31:0) after 1m0s
[04:40:03.494] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:31:0)
[04:40:03.494] Timer tick, asking Buildbucket for the build status
[04:40:03.606] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:40:03.606] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:32:0) after 1m0s
[04:41:03.629] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:32:0)
[04:41:03.629] Timer tick, asking Buildbucket for the build status
[04:41:04.129] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:41:04.129] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:33:0) after 1m0s
[04:42:04.204] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:33:0)
[04:42:04.204] Timer tick, asking Buildbucket for the build status
[04:42:04.326] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:42:04.326] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:34:0) after 1m0s
[04:43:04.358] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:34:0)
[04:43:04.358] Timer tick, asking Buildbucket for the build status
[04:43:04.463] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:43:04.463] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:35:0) after 1m0s
[04:44:04.504] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:35:0)
[04:44:04.504] Timer tick, asking Buildbucket for the build status
[04:44:04.593] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:44:04.593] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:36:0) after 1m0s
[04:45:04.653] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:36:0)
[04:45:04.653] Timer tick, asking Buildbucket for the build status
[04:45:04.765] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:45:04.765] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:37:0) after 1m0s
[04:46:04.817] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:37:0)
[04:46:04.817] Timer tick, asking Buildbucket for the build status
[04:46:05.302] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:46:05.302] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:38:0) after 1m0s
[04:47:05.409] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:38:0)
[04:47:05.410] Timer tick, asking Buildbucket for the build status
[04:47:05.710] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:47:05.710] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:39:0) after 1m0s
[04:48:05.726] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:39:0)
[04:48:05.726] Timer tick, asking Buildbucket for the build status
[04:48:05.898] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:48:05.898] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:40:0) after 1m0s
[04:49:06.128] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:40:0)
[04:49:06.128] Timer tick, asking Buildbucket for the build status
[04:49:06.429] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:49:06.429] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:41:0) after 1m0s
[04:50:06.473] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:41:0)
[04:50:06.473] Timer tick, asking Buildbucket for the build status
[04:50:06.643] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:50:06.643] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:42:0) after 1m0s
[04:51:06.665] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:42:0)
[04:51:06.665] Timer tick, asking Buildbucket for the build status
[04:51:07.090] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:51:07.090] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:43:0) after 1m0s
[04:52:07.183] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:43:0)
[04:52:07.183] Timer tick, asking Buildbucket for the build status
[04:52:07.409] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:52:07.409] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:44:0) after 1m0s
[04:53:07.507] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:44:0)
[04:53:07.507] Timer tick, asking Buildbucket for the build status
[04:53:07.596] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:53:07.596] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:45:0) after 1m0s
[04:54:07.629] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:45:0)
[04:54:07.629] Timer tick, asking Buildbucket for the build status
[04:54:07.719] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:54:07.719] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:46:0) after 1m0s
[04:55:07.746] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:46:0)
[04:55:07.746] Timer tick, asking Buildbucket for the build status
[04:55:07.842] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:55:07.842] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:47:0) after 1m0s
[04:56:07.899] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:47:0)
[04:56:07.899] Timer tick, asking Buildbucket for the build status
[04:56:08.071] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:56:08.071] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:48:0) after 1m0s
[04:57:08.114] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:48:0)
[04:57:08.114] Timer tick, asking Buildbucket for the build status
[04:57:08.337] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:57:08.337] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:49:0) after 1m0s
[04:58:08.457] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:49:0)
[04:58:08.457] Timer tick, asking Buildbucket for the build status
[04:58:08.567] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:58:08.567] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:50:0) after 1m0s
[04:59:08.599] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:50:0)
[04:59:08.599] Timer tick, asking Buildbucket for the build status
[04:59:08.748] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:59:08.748] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:51:0) after 1m0s
[05:00:08.927] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:51:0)
[05:00:08.927] Timer tick, asking Buildbucket for the build status
[05:00:09.366] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:00:09.366] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:52:0) after 1m0s
[05:01:10.129] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:52:0)
[05:01:10.129] Timer tick, asking Buildbucket for the build status
[05:01:10.939] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:01:10.939] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:53:0) after 1m0s
[05:02:10.944] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:53:0)
[05:02:10.944] Timer tick, asking Buildbucket for the build status
[05:02:11.024] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:02:11.024] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:54:0) after 1m0s
[05:03:11.087] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:54:0)
[05:03:11.087] Timer tick, asking Buildbucket for the build status
[05:03:13.725] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:03:13.725] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:55:0) after 1m0s
[05:04:13.795] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:55:0)
[05:04:13.795] Timer tick, asking Buildbucket for the build status
[05:04:13.929] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:04:13.929] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:56:0) after 1m0s
[05:05:13.955] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:56:0)
[05:05:13.955] Timer tick, asking Buildbucket for the build status
[05:05:14.052] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:05:14.052] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:57:0) after 1m0s
[05:06:14.234] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:57:0)
[05:06:14.234] Timer tick, asking Buildbucket for the build status
[05:06:14.496] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:06:14.496] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:58:0) after 1m0s
[05:07:14.501] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:58:0)
[05:07:14.501] Timer tick, asking Buildbucket for the build status
[05:07:14.559] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:07:14.559] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:59:0) after 1m0s
[05:08:14.636] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:59:0)
[05:08:14.636] Timer tick, asking Buildbucket for the build status
[05:08:14.729] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:08:14.729] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:60:0) after 1m0s
[05:09:14.802] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:60:0)
[05:09:14.802] Timer tick, asking Buildbucket for the build status
[05:09:14.958] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:09:14.958] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:61:0) after 1m0s
[05:10:14.980] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:61:0)
[05:10:14.980] Timer tick, asking Buildbucket for the build status
[05:10:15.044] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:10:15.044] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:62:0) after 1m0s
[05:11:15.167] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:62:0)
[05:11:15.167] Timer tick, asking Buildbucket for the build status
[05:11:15.305] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:11:15.306] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:63:0) after 1m0s
[05:12:15.325] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:63:0)
[05:12:15.325] Timer tick, asking Buildbucket for the build status
[05:12:15.487] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:12:15.487] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:64:0) after 1m0s
[05:13:15.537] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:64:0)
[05:13:15.537] Timer tick, asking Buildbucket for the build status
[05:13:15.615] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:13:15.615] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:65:0) after 1m0s
[05:14:15.684] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:65:0)
[05:14:15.684] Timer tick, asking Buildbucket for the build status
[05:14:16.275] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:14:16.275] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:66:0) after 1m0s
[05:15:16.302] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:66:0)
[05:15:16.302] Timer tick, asking Buildbucket for the build status
[05:15:16.433] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:15:16.433] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:67:0) after 1m0s
[05:16:17.811] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:67:0)
[05:16:17.811] Timer tick, asking Buildbucket for the build status
[05:16:18.387] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:16:18.387] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:68:0) after 1m0s
[05:17:18.469] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:68:0)
[05:17:18.469] Timer tick, asking Buildbucket for the build status
[05:17:18.558] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:17:18.558] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:69:0) after 1m0s
[05:18:18.731] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:69:0)
[05:18:18.731] Timer tick, asking Buildbucket for the build status
[05:18:18.925] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:18:18.925] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:70:0) after 1m0s
[05:19:19.031] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:70:0)
[05:19:19.031] Timer tick, asking Buildbucket for the build status
[05:19:19.241] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:19:19.241] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:71:0) after 1m0s
[05:20:19.345] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:71:0)
[05:20:19.345] Timer tick, asking Buildbucket for the build status
[05:20:19.461] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:20:19.461] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:72:0) after 1m0s
[05:21:19.585] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:72:0)
[05:21:19.585] Timer tick, asking Buildbucket for the build status
[05:21:20.140] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:21:20.141] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:73:0) after 1m0s
[05:22:20.261] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:73:0)
[05:22:20.261] Timer tick, asking Buildbucket for the build status
[05:22:20.565] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:22:20.565] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:74:0) after 1m0s
[05:23:20.652] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:74:0)
[05:23:20.652] Timer tick, asking Buildbucket for the build status
[05:23:20.844] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:23:20.844] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:75:0) after 1m0s
[05:24:20.977] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:75:0)
[05:24:20.977] Timer tick, asking Buildbucket for the build status
[05:24:21.057] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:24:21.057] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:76:0) after 1m0s
[05:25:21.230] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:76:0)
[05:25:21.230] Timer tick, asking Buildbucket for the build status
[05:25:21.434] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:25:21.434] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:77:0) after 1m0s
[05:26:21.483] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:77:0)
[05:26:21.483] Timer tick, asking Buildbucket for the build status
[05:26:22.128] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:26:22.128] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:78:0) after 1m0s
[05:27:22.225] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:78:0)
[05:27:22.225] Timer tick, asking Buildbucket for the build status
[05:27:22.494] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:27:22.494] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:79:0) after 1m0s
[05:28:22.878] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:79:0)
[05:28:22.878] Timer tick, asking Buildbucket for the build status
[05:28:23.176] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:28:23.176] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:80:0) after 1m0s
[05:29:23.343] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:80:0)
[05:29:23.343] Timer tick, asking Buildbucket for the build status
[05:29:23.504] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:29:23.504] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:81:0) after 1m0s
[05:30:23.615] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:81:0)
[05:30:23.615] Timer tick, asking Buildbucket for the build status
[05:30:23.747] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:30:23.747] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:82:0) after 1m0s
[05:31:23.885] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:82:0)
[05:31:23.885] Timer tick, asking Buildbucket for the build status
[05:31:24.179] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:31:24.180] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:83:0) after 1m0s
[05:32:24.242] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:83:0)
[05:32:24.242] Timer tick, asking Buildbucket for the build status
[05:32:24.409] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:32:24.409] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:84:0) after 1m0s
[05:33:24.408] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:84:0)
[05:33:24.408] Timer tick, asking Buildbucket for the build status
[05:33:24.487] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:33:24.487] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:85:0) after 1m0s
[05:34:24.570] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:85:0)
[05:34:24.570] Timer tick, asking Buildbucket for the build status
[05:34:24.757] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:34:24.757] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:86:0) after 1m0s
[05:35:24.797] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:86:0)
[05:35:24.797] Timer tick, asking Buildbucket for the build status
[05:35:24.903] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:35:24.903] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:87:0) after 1m0s
[05:36:25.000] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:87:0)
[05:36:25.000] Timer tick, asking Buildbucket for the build status
[05:36:25.476] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:36:25.476] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:88:0) after 1m0s
[05:37:25.544] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:88:0)
[05:37:25.544] Timer tick, asking Buildbucket for the build status
[05:37:25.615] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:37:25.615] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:89:0) after 1m0s
[05:38:25.744] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:89:0)
[05:38:25.744] Timer tick, asking Buildbucket for the build status
[05:38:26.027] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:38:26.027] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:90:0) after 1m0s
[05:39:26.123] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:90:0)
[05:39:26.123] Timer tick, asking Buildbucket for the build status
[05:39:26.366] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:39:26.366] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:91:0) after 1m0s
[05:40:26.427] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:91:0)
[05:40:26.427] Timer tick, asking Buildbucket for the build status
[05:40:26.491] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:40:26.491] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:92:0) after 1m0s
[05:41:26.536] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:92:0)
[05:41:26.536] Timer tick, asking Buildbucket for the build status
[05:41:26.893] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:41:26.893] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:93:0) after 1m0s
[05:42:26.953] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:93:0)
[05:42:26.953] Timer tick, asking Buildbucket for the build status
[05:42:27.226] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:42:27.226] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:94:0) after 1m0s
[05:43:27.306] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:94:0)
[05:43:27.306] Timer tick, asking Buildbucket for the build status
[05:43:27.439] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:43:27.439] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:95:0) after 1m0s
[05:44:27.456] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:95:0)
[05:44:27.456] Timer tick, asking Buildbucket for the build status
[05:44:27.569] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:44:27.569] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:96:0) after 1m0s
[05:45:27.594] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:96:0)
[05:45:27.594] Timer tick, asking Buildbucket for the build status
[05:45:27.690] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:45:27.690] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:97:0) after 1m0s
[05:46:27.799] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:97:0)
[05:46:27.799] Timer tick, asking Buildbucket for the build status
[05:46:27.924] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:46:27.924] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:98:0) after 1m0s
[05:47:28.067] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:98:0)
[05:47:28.067] Timer tick, asking Buildbucket for the build status
[05:47:28.153] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:47:28.153] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:99:0) after 1m0s
[05:48:28.235] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:99:0)
[05:48:28.235] Timer tick, asking Buildbucket for the build status
[05:48:28.327] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:48:28.328] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:100:0) after 1m0s
[05:49:28.382] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:100:0)
[05:49:28.382] Timer tick, asking Buildbucket for the build status
[05:49:28.466] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:49:28.466] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:101:0) after 1m0s
[05:50:28.520] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:101:0)
[05:50:28.520] Timer tick, asking Buildbucket for the build status
[05:50:29.069] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:50:29.069] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:102:0) after 1m0s
[05:51:29.206] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:102:0)
[05:51:29.206] Timer tick, asking Buildbucket for the build status
[05:51:29.583] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:51:29.583] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:103:0) after 1m0s
[05:52:29.675] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:103:0)
[05:52:29.675] Timer tick, asking Buildbucket for the build status
[05:52:29.777] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:52:29.777] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:104:0) after 1m0s
[05:53:29.871] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:104:0)
[05:53:29.871] Timer tick, asking Buildbucket for the build status
[05:53:30.176] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:53:30.176] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:105:0) after 1m0s
[05:54:30.260] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:105:0)
[05:54:30.260] Timer tick, asking Buildbucket for the build status
[05:54:30.343] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:54:30.343] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:106:0) after 1m0s
[05:55:30.382] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:106:0)
[05:55:30.382] Timer tick, asking Buildbucket for the build status
[05:55:30.468] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:55:30.468] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:107:0) after 1m0s
[05:56:30.540] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:107:0)
[05:56:30.540] Timer tick, asking Buildbucket for the build status
[05:56:30.668] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:56:30.668] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:108:0) after 1m0s
[05:57:30.761] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:108:0)
[05:57:30.761] Timer tick, asking Buildbucket for the build status
[05:57:30.864] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:57:30.864] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:109:0) after 1m0s
[05:58:30.957] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:109:0)
[05:58:30.957] Timer tick, asking Buildbucket for the build status
[05:58:31.537] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:58:31.537] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:110:0) after 1m0s
[05:59:31.647] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:110:0)
[05:59:31.647] Timer tick, asking Buildbucket for the build status
[05:59:31.805] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:59:31.805] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:111:0) after 1m0s
[06:00:31.892] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:111:0)
[06:00:31.892] Timer tick, asking Buildbucket for the build status
[06:00:32.083] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:00:32.083] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:112:0) after 1m0s
[06:01:32.151] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:112:0)
[06:01:32.151] Timer tick, asking Buildbucket for the build status
[06:01:32.386] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:01:32.386] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:113:0) after 1m0s
[06:02:32.392] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:113:0)
[06:02:32.392] Timer tick, asking Buildbucket for the build status
[06:02:32.487] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:02:32.487] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:114:0) after 1m0s
[06:03:32.595] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:114:0)
[06:03:32.595] Timer tick, asking Buildbucket for the build status
[06:03:34.559] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:03:34.559] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:115:0) after 1m0s
[06:04:34.622] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:115:0)
[06:04:34.622] Timer tick, asking Buildbucket for the build status
[06:04:34.824] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:04:34.824] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:116:0) after 1m0s
[06:05:34.808] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:116:0)
[06:05:34.808] Timer tick, asking Buildbucket for the build status
[06:05:35.178] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:05:35.178] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:117:0) after 1m0s
[06:06:35.203] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:117:0)
[06:06:35.203] Timer tick, asking Buildbucket for the build status
[06:06:35.514] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:06:35.514] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:118:0) after 1m0s
[06:07:35.616] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:118:0)
[06:07:35.616] Timer tick, asking Buildbucket for the build status
[06:07:35.687] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:07:35.687] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:119:0) after 1m0s
[06:08:35.726] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:119:0)
[06:08:35.726] Timer tick, asking Buildbucket for the build status
[06:08:35.907] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:08:35.907] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:120:0) after 1m0s
[06:09:35.939] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:120:0)
[06:09:35.939] Timer tick, asking Buildbucket for the build status
[06:09:36.024] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:09:36.024] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:121:0) after 1m0s
[06:10:36.048] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:121:0)
[06:10:36.048] Timer tick, asking Buildbucket for the build status
[06:10:36.132] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:10:36.132] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:122:0) after 1m0s
[06:11:36.158] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:122:0)
[06:11:36.158] Timer tick, asking Buildbucket for the build status
[06:11:36.323] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:11:36.323] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:123:0) after 1m0s
[06:12:36.383] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:123:0)
[06:12:36.383] Timer tick, asking Buildbucket for the build status
[06:12:36.501] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:12:36.501] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:124:0) after 1m0s
[06:13:36.595] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:124:0)
[06:13:36.595] Timer tick, asking Buildbucket for the build status
[06:13:36.718] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:13:36.718] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:125:0) after 1m0s
[06:14:36.792] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:125:0)
[06:14:36.792] Timer tick, asking Buildbucket for the build status
[06:14:36.956] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:14:36.956] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:126:0) after 1m0s
[06:15:37.103] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:126:0)
[06:15:37.103] Timer tick, asking Buildbucket for the build status
[06:15:37.227] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:15:37.227] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:127:0) after 1m0s
[06:16:37.364] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:127:0)
[06:16:37.364] Timer tick, asking Buildbucket for the build status
[06:16:37.483] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:16:37.483] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:128:0) after 1m0s
[06:17:37.619] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:128:0)
[06:17:37.619] Timer tick, asking Buildbucket for the build status
[06:17:37.730] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:17:37.730] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:129:0) after 1m0s
[06:18:37.757] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:129:0)
[06:18:37.757] Timer tick, asking Buildbucket for the build status
[06:18:37.847] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:18:37.847] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:130:0) after 1m0s
[06:19:37.853] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:130:0)
[06:19:37.853] Timer tick, asking Buildbucket for the build status
[06:19:37.974] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:19:37.974] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:131:0) after 1m0s
[06:20:38.107] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:131:0)
[06:20:38.107] Timer tick, asking Buildbucket for the build status
[06:20:38.551] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:20:38.551] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:132:0) after 1m0s
[06:21:38.686] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:132:0)
[06:21:38.686] Timer tick, asking Buildbucket for the build status
[06:21:38.907] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:21:38.908] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:133:0) after 1m0s
[06:22:38.938] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:133:0)
[06:22:38.938] Timer tick, asking Buildbucket for the build status
[06:22:39.034] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:22:39.034] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:134:0) after 1m0s
[06:23:39.172] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:134:0)
[06:23:39.172] Timer tick, asking Buildbucket for the build status
[06:23:39.277] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:23:39.277] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:135:0) after 1m0s
[06:24:39.396] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:135:0)
[06:24:39.396] Timer tick, asking Buildbucket for the build status
[06:24:39.537] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:24:39.537] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:136:0) after 1m0s
[06:25:39.573] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:136:0)
[06:25:39.573] Timer tick, asking Buildbucket for the build status
[06:25:39.648] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:25:39.648] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:137:0) after 1m0s
[06:26:39.689] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:137:0)
[06:26:39.689] Timer tick, asking Buildbucket for the build status
[06:26:40.294] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:26:40.294] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:138:0) after 1m0s
[06:27:40.331] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:138:0)
[06:27:40.331] Timer tick, asking Buildbucket for the build status
[06:27:40.400] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:27:40.400] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:139:0) after 1m0s
[06:28:40.447] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:139:0)
[06:28:40.448] Timer tick, asking Buildbucket for the build status
[06:28:40.561] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:28:40.561] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:140:0) after 1m0s
[06:29:40.697] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:140:0)
[06:29:40.697] Timer tick, asking Buildbucket for the build status
[06:29:40.787] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:29:40.787] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:141:0) after 1m0s
[06:30:40.823] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:141:0)
[06:30:40.823] Timer tick, asking Buildbucket for the build status
[06:30:40.913] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:30:40.913] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:142:0) after 1m0s
[06:31:41.028] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:142:0)
[06:31:41.028] Timer tick, asking Buildbucket for the build status
[06:31:41.182] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:31:41.182] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:143:0) after 1m0s
[06:32:41.238] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:143:0)
[06:32:41.238] Timer tick, asking Buildbucket for the build status
[06:32:41.345] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:32:41.345] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:144:0) after 1m0s
[06:33:41.555] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:144:0)
[06:33:41.555] Timer tick, asking Buildbucket for the build status
[06:33:41.954] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:33:41.954] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:145:0) after 1m0s
[06:34:42.050] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:145:0)
[06:34:42.050] Timer tick, asking Buildbucket for the build status
[06:34:42.234] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:34:42.234] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:146:0) after 1m0s
[06:35:42.367] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:146:0)
[06:35:42.367] Timer tick, asking Buildbucket for the build status
[06:35:42.481] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:35:42.481] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:147:0) after 1m0s
[06:36:42.779] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:147:0)
[06:36:42.779] Timer tick, asking Buildbucket for the build status
[06:36:43.202] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:36:43.202] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:148:0) after 1m0s
[06:37:43.246] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:148:0)
[06:37:43.246] Timer tick, asking Buildbucket for the build status
[06:37:43.557] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:37:43.557] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:149:0) after 1m0s
[06:38:43.675] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:149:0)
[06:38:43.675] Timer tick, asking Buildbucket for the build status
[06:38:43.792] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:38:43.793] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:150:0) after 1m0s
[06:39:43.822] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:150:0)
[06:39:43.822] Timer tick, asking Buildbucket for the build status
[06:39:44.184] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:39:44.184] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:151:0) after 1m0s
[06:40:44.352] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:151:0)
[06:40:44.352] Timer tick, asking Buildbucket for the build status
[06:40:44.580] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:40:44.580] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:152:0) after 1m0s
[06:41:44.671] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:152:0)
[06:41:44.671] Timer tick, asking Buildbucket for the build status
[06:41:45.181] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:41:45.181] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:153:0) after 1m0s
[06:42:45.354] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:153:0)
[06:42:45.354] Timer tick, asking Buildbucket for the build status
[06:42:45.425] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:42:45.425] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:154:0) after 1m0s
[06:43:45.528] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:154:0)
[06:43:45.528] Timer tick, asking Buildbucket for the build status
[06:43:45.638] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:43:45.638] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:155:0) after 1m0s
[06:44:45.849] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:155:0)
[06:44:45.849] Timer tick, asking Buildbucket for the build status
[06:44:45.933] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:44:45.933] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:156:0) after 1m0s
[06:45:46.093] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:156:0)
[06:45:46.093] Timer tick, asking Buildbucket for the build status
[06:45:46.316] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:45:46.316] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:157:0) after 1m0s
[06:46:46.379] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:157:0)
[06:46:46.379] Timer tick, asking Buildbucket for the build status
[06:46:46.595] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:46:46.595] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:158:0) after 1m0s
[06:47:46.833] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:158:0)
[06:47:46.833] Timer tick, asking Buildbucket for the build status
[06:47:47.035] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:47:47.035] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:159:0) after 1m0s
[06:48:47.183] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:159:0)
[06:48:47.184] Timer tick, asking Buildbucket for the build status
[06:48:47.369] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:48:47.369] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:160:0) after 1m0s
[06:49:47.385] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:160:0)
[06:49:47.385] Timer tick, asking Buildbucket for the build status
[06:49:47.643] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:49:47.643] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:161:0) after 1m0s
[06:50:47.733] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:161:0)
[06:50:47.733] Timer tick, asking Buildbucket for the build status
[06:50:47.860] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:50:47.860] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:162:0) after 1m0s
[06:51:47.933] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:162:0)
[06:51:47.933] Timer tick, asking Buildbucket for the build status
[06:51:48.071] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:51:48.071] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:163:0) after 1m0s
[06:52:48.181] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:163:0)
[06:52:48.181] Timer tick, asking Buildbucket for the build status
[06:52:48.260] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:52:48.261] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:164:0) after 1m0s
[06:53:48.420] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:164:0)
[06:53:48.420] Timer tick, asking Buildbucket for the build status
[06:53:48.487] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:53:48.487] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:165:0) after 1m0s
[06:54:48.560] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:165:0)
[06:54:48.560] Timer tick, asking Buildbucket for the build status
[06:54:48.638] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:54:48.638] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:166:0) after 1m0s
[06:55:48.769] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:166:0)
[06:55:48.769] Timer tick, asking Buildbucket for the build status
[06:55:48.874] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:55:48.874] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:167:0) after 1m0s
[06:56:49.114] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:167:0)
[06:56:49.115] Timer tick, asking Buildbucket for the build status
[06:56:49.265] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:56:49.265] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:168:0) after 1m0s
[06:57:49.449] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:168:0)
[06:57:49.449] Timer tick, asking Buildbucket for the build status
[06:57:49.647] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:57:49.647] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:169:0) after 1m0s
[06:58:49.783] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:169:0)
[06:58:49.783] Timer tick, asking Buildbucket for the build status
[06:58:49.862] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:58:49.862] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:170:0) after 1m0s
[06:59:49.979] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:170:0)
[06:59:49.979] Timer tick, asking Buildbucket for the build status
[06:59:50.145] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:59:50.145] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:171:0) after 1m0s
[07:00:50.283] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:171:0)
[07:00:50.283] Timer tick, asking Buildbucket for the build status
[07:00:50.717] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:00:50.717] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:172:0) after 1m0s
[07:01:50.937] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:172:0)
[07:01:50.937] Timer tick, asking Buildbucket for the build status
[07:01:51.136] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:01:51.136] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:173:0) after 1m0s
[07:02:51.313] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:173:0)
[07:02:51.313] Timer tick, asking Buildbucket for the build status
[07:02:51.502] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:02:51.502] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:174:0) after 1m0s
[07:03:51.598] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:174:0)
[07:03:51.598] Timer tick, asking Buildbucket for the build status
[07:03:51.867] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:03:51.867] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:175:0) after 1m0s
[07:04:51.960] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:175:0)
[07:04:51.960] Timer tick, asking Buildbucket for the build status
[07:04:52.272] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:04:52.272] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:176:0) after 1m0s
[07:05:52.374] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:176:0)
[07:05:52.374] Timer tick, asking Buildbucket for the build status
[07:05:52.440] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:05:52.441] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:177:0) after 1m0s
[07:06:52.525] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:177:0)
[07:06:52.525] Timer tick, asking Buildbucket for the build status
[07:06:52.835] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:06:52.835] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:178:0) after 1m0s
[07:07:53.002] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:178:0)
[07:07:53.002] Timer tick, asking Buildbucket for the build status
[07:07:53.101] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:07:53.101] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:179:0) after 1m0s
[07:08:53.423] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:179:0)
[07:08:53.423] Timer tick, asking Buildbucket for the build status
[07:08:53.770] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:08:53.771] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:180:0) after 1m0s
[07:09:53.890] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:180:0)
[07:09:53.890] Timer tick, asking Buildbucket for the build status
[07:09:54.256] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:09:54.256] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:181:0) after 1m0s
[07:10:54.443] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:181:0)
[07:10:54.443] Timer tick, asking Buildbucket for the build status
[07:10:55.000] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:10:55.000] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:182:0) after 1m0s
[07:11:55.116] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:182:0)
[07:11:55.116] Timer tick, asking Buildbucket for the build status
[07:11:55.352] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:11:55.352] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:183:0) after 1m0s
[07:12:55.425] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:183:0)
[07:12:55.425] Timer tick, asking Buildbucket for the build status
[07:12:55.546] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:12:55.546] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:184:0) after 1m0s
[07:13:55.590] Handling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:184:0)
[07:13:55.590] Timer tick, asking Buildbucket for the build status
[07:14:00.476] Build 8872927189210778992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:14:00.476] Scheduling timer "check-buildbucket-build-status" (chromium/win-official:9038357251206928176:185:0) after 1m0s
[07:14:28.256] Received PubSub notification, asking Buildbucket for the build status
[07:14:28.363] Build 8872927189210778992: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[07:14:28.363] Buildbucket build:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "completed_ts": "1596525265726768",
    "created_by": "project:chromium",
    "created_ts": "1596514250514532",
    "id": "8872927189210778992",
    "parameters_json": "{\"builder_name\": \"win-official\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"c7e728612fc890720eda3b6c72fcc1e37249a72e\"}}",
    "project": "chromium",
    "result": "SUCCESS",
    "result_details_json": "{\"properties\": {\"$build/chromium_tests\": {\"bucketed_triggers\": true}, \"$build/goma\": {\"enable_ats\": true, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$recipe_engine/milo/blamelist_pins\": [{\"host\": \"chromium.googlesource.com\", \"id\": \"c7e728612fc890720eda3b6c72fcc1e37249a72e\", \"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-6-w2va\", \"branch\": \"refs/heads/master\", \"buildername\": \"win-official\", \"buildnumber\": 249, \"got_angle_revision\": \"709472c9dd0c413ceb944e06afb600d741e63720\", \"got_dawn_revision\": \"1ea3a22f521ef0e0c7ed4ba9f41ac56b5157a7f0\", \"got_nacl_revision\": \"3008f9e6de122325d8f9dbf02f7cdd51fa1ec306\", \"got_revision\": \"c7e728612fc890720eda3b6c72fcc1e37249a72e\", \"got_revision_cp\": \"refs/heads/master@{#794378}\", \"got_swarming_client_revision\": \"4c095d04179dc725a300085ae21fe3b79900d072\", \"got_swiftshader_revision\": \"74cc8ea2b8df3e6e43430cfcfd71d47f7bef39f9\", \"got_v8_revision\": \"2b884e02be1a184ce9c40742fb80261e86779b08\", \"got_v8_revision_cp\": \"refs/heads/8.6.326@{#1}\", \"got_webrtc_revision\": \"7e30909bf44a224f7dbb49fc6bac6f2fdd4fd822\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#31842}\", \"mastername\": \"chromium\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"c7e728612fc890720eda3b6c72fcc1e37249a72e\"}, \"swarming\": {\"bot_dimensions\": {\"builder\": [\"win-archive-dbg\", \"win-archive-rel\", \"win-official\", \"win32-archive-dbg\", \"win32-archive-rel\", \"win32-official\"], \"caches\": [\"builder_9b3ebe5fd1c5be87380c40d216747346a59b28cf26de183f0e8e2b32e944d3c8_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-6-w2va\"], \"image\": [\"chrome-win10-1703-20073100-2eb11ddbc6e\"], \"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\": [\"5436-adf7f8a\"], \"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": "1596514400425857",
    "status": "COMPLETED",
    "status_changed_ts": "1596525267574559",
    "tags": [
      "build_address:luci.chromium.ci/win-official/249",
      "builder:win-official",
      "buildset:commit/git/c7e728612fc890720eda3b6c72fcc1e37249a72e",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/c7e728612fc890720eda3b6c72fcc1e37249a72e",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9038357251206928176",
      "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/8872927189210778992/+/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:4dd07bc067456010",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1596525267674203",
    "url": "https://ci.chromium.org/b/8872927189210778992",
    "utcnow_ts": "1596525268355649"
  }
}
[07:14:28.363] Invocation finished in 3h3m39.135654976s with status SUCCEEDED