Status: FAILED
Triggered by: -
Duration: 3 hours
Actions:

Definition (rev 4c3247f4ed8a00ea6dc37d6edf987ff8d0e003c5)

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

Incoming triggers

Incoming properties

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

Incoming tags

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

Debug log (UTC)

[20:46:22.178] New invocation is queued and will start shortly
[20:46:23.313] Starting the invocation (attempt 1)
[20:46:23.357] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[20:46:23.357] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[20:46:23.357] Buildbucket request:
{
  "bucket": "luci.chromium.ci",
  "client_operation_id": "9084499069549926928",
  "parameters_json": "{\"builder_name\":\"Windows deterministic\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src.git\",\"revision\":\"e6b703611b2ee011be434da39e5272d3ad21ca7c\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:Windows deterministic",
    "scheduler_invocation_id:9084499069549926928",
    "scheduler_job_id:chromium/Windows deterministic",
    "user_agent:luci-scheduler",
    "buildset:commit/git/e6b703611b2ee011be434da39e5272d3ad21ca7c",
    "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/e6b703611b2ee011be434da39e5272d3ad21ca7c",
    "gitiles_ref:refs/heads/master"
  ]
}
[20:46:24.667] Buildbucket response:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "AUTO",
    "created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
    "created_ts": "1552509983434423",
    "id": "8919069007568537984",
    "lease_expiration_ts": "1552628784310761",
    "lease_key": "5440420",
    "parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"e6b703611b2ee011be434da39e5272d3ad21ca7c\"}}",
    "project": "chromium",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1552509984426268",
    "tags": [
      "build_address:luci.chromium.ci/Windows deterministic/12416",
      "builder:Windows deterministic",
      "buildset:commit/git/e6b703611b2ee011be434da39e5272d3ad21ca7c",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/e6b703611b2ee011be434da39e5272d3ad21ca7c",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9084499069549926928",
      "scheduler_job_id:chromium/Windows deterministic",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8919069007568537984/+/annotations",
      "swarming_tag:luci_project:chromium",
      "swarming_tag:recipe_name:swarming/deterministic_build",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
      "swarming_task_id:43919fe53d1d6210",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1552509984426419",
    "url": "https://ci.chromium.org/b/8919069007568537984",
    "utcnow_ts": "1552509984656175"
  }
}
[20:46:24.667] Task URL: https://ci.chromium.org/b/8919069007568537984
[20:46:24.667] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:2:0) after 1m0s
[20:47:24.636] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:2:0)
[20:47:24.636] Timer tick, asking Buildbucket for the build status
[20:47:24.761] Build 8919069007568537984: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[20:47:24.761] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:3:0) after 1m0s
[20:48:03.851] Received PubSub notification, asking Buildbucket for the build status
[20:48:03.972] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:48:24.782] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:3:0)
[20:48:24.782] Timer tick, asking Buildbucket for the build status
[20:48:24.831] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:48:24.831] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:5:0) after 1m0s
[20:49:24.861] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:5:0)
[20:49:24.862] Timer tick, asking Buildbucket for the build status
[20:49:24.911] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:49:24.911] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:6:0) after 1m0s
[20:50:24.933] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:6:0)
[20:50:24.933] Timer tick, asking Buildbucket for the build status
[20:50:24.989] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:50:24.989] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:7:0) after 1m0s
[20:51:24.987] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:7:0)
[20:51:24.987] Timer tick, asking Buildbucket for the build status
[20:51:25.173] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:51:25.173] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:8:0) after 1m0s
[20:52:25.189] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:8:0)
[20:52:25.189] Timer tick, asking Buildbucket for the build status
[20:52:25.242] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:52:25.242] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:9:0) after 1m0s
[20:53:25.245] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:9:0)
[20:53:25.245] Timer tick, asking Buildbucket for the build status
[20:53:25.298] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:53:25.298] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:10:0) after 1m0s
[20:54:25.307] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:10:0)
[20:54:25.307] Timer tick, asking Buildbucket for the build status
[20:54:25.360] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:54:25.360] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:11:0) after 1m0s
[20:55:25.368] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:11:0)
[20:55:25.368] Timer tick, asking Buildbucket for the build status
[20:55:25.407] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:55:25.407] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:12:0) after 1m0s
[20:56:25.393] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:12:0)
[20:56:25.393] Timer tick, asking Buildbucket for the build status
[20:56:25.446] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:56:25.446] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:13:0) after 1m0s
[20:57:25.466] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:13:0)
[20:57:25.466] Timer tick, asking Buildbucket for the build status
[20:57:25.559] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:57:25.559] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:14:0) after 1m0s
[20:58:25.578] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:14:0)
[20:58:25.578] Timer tick, asking Buildbucket for the build status
[20:58:25.651] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:58:25.651] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:15:0) after 1m0s
[20:59:25.667] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:15:0)
[20:59:25.667] Timer tick, asking Buildbucket for the build status
[20:59:25.779] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[20:59:25.779] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:16:0) after 1m0s
[21:00:25.802] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:16:0)
[21:00:25.802] Timer tick, asking Buildbucket for the build status
[21:00:25.837] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:00:25.837] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:17:0) after 1m0s
[21:01:25.851] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:17:0)
[21:01:25.851] Timer tick, asking Buildbucket for the build status
[21:01:25.887] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:01:25.887] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:18:0) after 1m0s
[21:02:25.901] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:18:0)
[21:02:25.901] Timer tick, asking Buildbucket for the build status
[21:02:26.021] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:02:26.021] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:19:0) after 1m0s
[21:03:26.101] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:19:0)
[21:03:26.101] Timer tick, asking Buildbucket for the build status
[21:03:29.785] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:03:29.785] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:20:0) after 1m0s
[21:04:29.826] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:20:0)
[21:04:29.826] Timer tick, asking Buildbucket for the build status
[21:04:29.863] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:04:29.863] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:21:0) after 1m0s
[21:05:29.883] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:21:0)
[21:05:29.883] Timer tick, asking Buildbucket for the build status
[21:05:29.937] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:05:29.937] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:22:0) after 1m0s
[21:06:29.941] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:22:0)
[21:06:29.941] Timer tick, asking Buildbucket for the build status
[21:06:30.020] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:06:30.020] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:23:0) after 1m0s
[21:07:30.046] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:23:0)
[21:07:30.046] Timer tick, asking Buildbucket for the build status
[21:07:30.115] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:07:30.116] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:24:0) after 1m0s
[21:08:30.152] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:24:0)
[21:08:30.152] Timer tick, asking Buildbucket for the build status
[21:08:30.204] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:08:30.204] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:25:0) after 1m0s
[21:09:30.231] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:25:0)
[21:09:30.231] Timer tick, asking Buildbucket for the build status
[21:09:30.288] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:09:30.288] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:26:0) after 1m0s
[21:10:30.297] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:26:0)
[21:10:30.297] Timer tick, asking Buildbucket for the build status
[21:10:30.369] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:10:30.370] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:27:0) after 1m0s
[21:11:30.391] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:27:0)
[21:11:30.391] Timer tick, asking Buildbucket for the build status
[21:11:30.453] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:11:30.453] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:28:0) after 1m0s
[21:12:30.455] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:28:0)
[21:12:30.455] Timer tick, asking Buildbucket for the build status
[21:12:30.491] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:12:30.491] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:29:0) after 1m0s
[21:13:30.469] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:29:0)
[21:13:30.469] Timer tick, asking Buildbucket for the build status
[21:13:30.611] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:13:30.611] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:30:0) after 1m0s
[21:14:30.648] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:30:0)
[21:14:30.648] Timer tick, asking Buildbucket for the build status
[21:14:30.778] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:14:30.778] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:31:0) after 1m0s
[21:15:30.797] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:31:0)
[21:15:30.797] Timer tick, asking Buildbucket for the build status
[21:15:30.843] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:15:30.843] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:32:0) after 1m0s
[21:16:30.872] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:32:0)
[21:16:30.872] Timer tick, asking Buildbucket for the build status
[21:16:30.932] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:16:30.932] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:33:0) after 1m0s
[21:17:30.943] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:33:0)
[21:17:30.943] Timer tick, asking Buildbucket for the build status
[21:17:31.006] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:17:31.006] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:34:0) after 1m0s
[21:18:31.012] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:34:0)
[21:18:31.012] Timer tick, asking Buildbucket for the build status
[21:18:31.097] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:18:31.097] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:35:0) after 1m0s
[21:19:31.122] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:35:0)
[21:19:31.122] Timer tick, asking Buildbucket for the build status
[21:19:31.161] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:19:31.161] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:36:0) after 1m0s
[21:20:31.153] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:36:0)
[21:20:31.153] Timer tick, asking Buildbucket for the build status
[21:20:31.208] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:20:31.208] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:37:0) after 1m0s
[21:21:31.230] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:37:0)
[21:21:31.230] Timer tick, asking Buildbucket for the build status
[21:21:31.290] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:21:31.290] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:38:0) after 1m0s
[21:22:31.285] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:38:0)
[21:22:31.285] Timer tick, asking Buildbucket for the build status
[21:22:31.343] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:22:31.343] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:39:0) after 1m0s
[21:23:31.360] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:39:0)
[21:23:31.360] Timer tick, asking Buildbucket for the build status
[21:23:31.420] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:23:31.420] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:40:0) after 1m0s
[21:24:31.411] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:40:0)
[21:24:31.411] Timer tick, asking Buildbucket for the build status
[21:24:31.452] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:24:31.452] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:41:0) after 1m0s
[21:25:31.474] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:41:0)
[21:25:31.474] Timer tick, asking Buildbucket for the build status
[21:25:31.777] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:25:31.777] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:42:0) after 1m0s
[21:26:31.803] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:42:0)
[21:26:31.803] Timer tick, asking Buildbucket for the build status
[21:26:31.888] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:26:31.888] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:43:0) after 1m0s
[21:27:31.903] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:43:0)
[21:27:31.903] Timer tick, asking Buildbucket for the build status
[21:27:31.940] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:27:31.940] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:44:0) after 1m0s
[21:28:31.990] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:44:0)
[21:28:31.990] Timer tick, asking Buildbucket for the build status
[21:28:32.049] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:28:32.049] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:45:0) after 1m0s
[21:29:32.030] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:45:0)
[21:29:32.030] Timer tick, asking Buildbucket for the build status
[21:29:32.069] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:29:32.069] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:46:0) after 1m0s
[21:30:32.095] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:46:0)
[21:30:32.095] Timer tick, asking Buildbucket for the build status
[21:30:32.282] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:30:32.282] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:47:0) after 1m0s
[21:31:32.308] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:47:0)
[21:31:32.308] Timer tick, asking Buildbucket for the build status
[21:31:32.355] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:31:32.355] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:48:0) after 1m0s
[21:32:32.373] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:48:0)
[21:32:32.373] Timer tick, asking Buildbucket for the build status
[21:32:32.592] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:32:32.592] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:49:0) after 1m0s
[21:33:32.612] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:49:0)
[21:33:32.612] Timer tick, asking Buildbucket for the build status
[21:33:32.696] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:33:32.696] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:50:0) after 1m0s
[21:34:32.743] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:50:0)
[21:34:32.743] Timer tick, asking Buildbucket for the build status
[21:34:32.810] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:34:32.810] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:51:0) after 1m0s
[21:35:32.806] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:51:0)
[21:35:32.806] Timer tick, asking Buildbucket for the build status
[21:35:33.108] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:35:33.108] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:52:0) after 1m0s
[21:36:33.095] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:52:0)
[21:36:33.095] Timer tick, asking Buildbucket for the build status
[21:36:33.170] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:36:33.170] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:53:0) after 1m0s
[21:37:33.205] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:53:0)
[21:37:33.205] Timer tick, asking Buildbucket for the build status
[21:37:33.396] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:37:33.396] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:54:0) after 1m0s
[21:38:33.399] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:54:0)
[21:38:33.399] Timer tick, asking Buildbucket for the build status
[21:38:33.475] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:38:33.475] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:55:0) after 1m0s
[21:39:33.560] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:55:0)
[21:39:33.560] Timer tick, asking Buildbucket for the build status
[21:39:33.645] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:39:33.645] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:56:0) after 1m0s
[21:40:33.668] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:56:0)
[21:40:33.668] Timer tick, asking Buildbucket for the build status
[21:40:33.989] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:40:33.990] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:57:0) after 1m0s
[21:41:34.014] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:57:0)
[21:41:34.014] Timer tick, asking Buildbucket for the build status
[21:41:34.100] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:41:34.100] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:58:0) after 1m0s
[21:42:34.125] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:58:0)
[21:42:34.125] Timer tick, asking Buildbucket for the build status
[21:42:34.200] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:42:34.200] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:59:0) after 1m0s
[21:43:34.220] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:59:0)
[21:43:34.220] Timer tick, asking Buildbucket for the build status
[21:43:34.501] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:43:34.501] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:60:0) after 1m0s
[21:44:34.547] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:60:0)
[21:44:34.547] Timer tick, asking Buildbucket for the build status
[21:44:34.578] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:44:34.578] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:61:0) after 1m0s
[21:45:34.600] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:61:0)
[21:45:34.600] Timer tick, asking Buildbucket for the build status
[21:45:34.721] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:45:34.721] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:62:0) after 1m0s
[21:46:34.715] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:62:0)
[21:46:34.715] Timer tick, asking Buildbucket for the build status
[21:46:34.753] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:46:34.753] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:63:0) after 1m0s
[21:47:34.803] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:63:0)
[21:47:34.803] Timer tick, asking Buildbucket for the build status
[21:47:34.868] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:47:34.868] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:64:0) after 1m0s
[21:48:34.890] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:64:0)
[21:48:34.891] Timer tick, asking Buildbucket for the build status
[21:48:34.974] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:48:34.974] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:65:0) after 1m0s
[21:49:34.962] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:65:0)
[21:49:34.962] Timer tick, asking Buildbucket for the build status
[21:49:35.001] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:49:35.001] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:66:0) after 1m0s
[21:50:34.987] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:66:0)
[21:50:34.987] Timer tick, asking Buildbucket for the build status
[21:50:35.179] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:50:35.179] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:67:0) after 1m0s
[21:51:35.219] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:67:0)
[21:51:35.219] Timer tick, asking Buildbucket for the build status
[21:51:35.312] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:51:35.312] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:68:0) after 1m0s
[21:52:35.338] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:68:0)
[21:52:35.338] Timer tick, asking Buildbucket for the build status
[21:52:35.402] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:52:35.402] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:69:0) after 1m0s
[21:53:35.377] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:69:0)
[21:53:35.377] Timer tick, asking Buildbucket for the build status
[21:53:35.514] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:53:35.514] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:70:0) after 1m0s
[21:54:35.543] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:70:0)
[21:54:35.543] Timer tick, asking Buildbucket for the build status
[21:54:35.589] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:54:35.589] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:71:0) after 1m0s
[21:55:35.571] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:71:0)
[21:55:35.571] Timer tick, asking Buildbucket for the build status
[21:55:35.631] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:55:35.631] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:72:0) after 1m0s
[21:56:35.654] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:72:0)
[21:56:35.654] Timer tick, asking Buildbucket for the build status
[21:56:35.696] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:56:35.696] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:73:0) after 1m0s
[21:57:35.723] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:73:0)
[21:57:35.723] Timer tick, asking Buildbucket for the build status
[21:57:35.783] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:57:35.783] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:74:0) after 1m0s
[21:58:35.766] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:74:0)
[21:58:35.766] Timer tick, asking Buildbucket for the build status
[21:58:35.975] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:58:35.975] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:75:0) after 1m0s
[21:59:35.956] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:75:0)
[21:59:35.956] Timer tick, asking Buildbucket for the build status
[21:59:35.994] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:59:35.994] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:76:0) after 1m0s
[22:00:36.017] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:76:0)
[22:00:36.017] Timer tick, asking Buildbucket for the build status
[22:00:36.199] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:00:36.199] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:77:0) after 1m0s
[22:01:36.235] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:77:0)
[22:01:36.235] Timer tick, asking Buildbucket for the build status
[22:01:36.842] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:01:36.842] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:78:0) after 1m0s
[22:02:36.865] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:78:0)
[22:02:36.865] Timer tick, asking Buildbucket for the build status
[22:02:36.903] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:02:36.903] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:79:0) after 1m0s
[22:03:36.999] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:79:0)
[22:03:36.999] Timer tick, asking Buildbucket for the build status
[22:03:37.197] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:03:37.198] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:80:0) after 1m0s
[22:04:37.195] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:80:0)
[22:04:37.195] Timer tick, asking Buildbucket for the build status
[22:04:37.236] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:04:37.236] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:81:0) after 1m0s
[22:05:37.221] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:81:0)
[22:05:37.221] Timer tick, asking Buildbucket for the build status
[22:05:37.256] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:05:37.256] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:82:0) after 1m0s
[22:06:37.269] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:82:0)
[22:06:37.269] Timer tick, asking Buildbucket for the build status
[22:06:37.311] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:06:37.311] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:83:0) after 1m0s
[22:07:37.338] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:83:0)
[22:07:37.338] Timer tick, asking Buildbucket for the build status
[22:07:37.374] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:07:37.374] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:84:0) after 1m0s
[22:08:37.393] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:84:0)
[22:08:37.394] Timer tick, asking Buildbucket for the build status
[22:08:37.467] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:08:37.468] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:85:0) after 1m0s
[22:09:37.489] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:85:0)
[22:09:37.489] Timer tick, asking Buildbucket for the build status
[22:09:37.525] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:09:37.525] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:86:0) after 1m0s
[22:10:37.549] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:86:0)
[22:10:37.549] Timer tick, asking Buildbucket for the build status
[22:10:37.690] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:10:37.690] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:87:0) after 1m0s
[22:11:37.690] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:87:0)
[22:11:37.690] Timer tick, asking Buildbucket for the build status
[22:11:37.772] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:11:37.772] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:88:0) after 1m0s
[22:12:37.797] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:88:0)
[22:12:37.797] Timer tick, asking Buildbucket for the build status
[22:12:37.833] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:12:37.833] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:89:0) after 1m0s
[22:13:37.864] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:89:0)
[22:13:37.864] Timer tick, asking Buildbucket for the build status
[22:13:38.013] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:13:38.013] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:90:0) after 1m0s
[22:14:38.035] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:90:0)
[22:14:38.035] Timer tick, asking Buildbucket for the build status
[22:14:38.097] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:14:38.097] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:91:0) after 1m0s
[22:15:38.122] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:91:0)
[22:15:38.122] Timer tick, asking Buildbucket for the build status
[22:15:38.169] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:15:38.169] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:92:0) after 1m0s
[22:16:38.192] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:92:0)
[22:16:38.192] Timer tick, asking Buildbucket for the build status
[22:16:38.272] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:16:38.272] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:93:0) after 1m0s
[22:17:38.277] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:93:0)
[22:17:38.277] Timer tick, asking Buildbucket for the build status
[22:17:38.315] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:17:38.315] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:94:0) after 1m0s
[22:18:38.303] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:94:0)
[22:18:38.303] Timer tick, asking Buildbucket for the build status
[22:18:38.336] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:18:38.336] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:95:0) after 1m0s
[22:19:38.370] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:95:0)
[22:19:38.370] Timer tick, asking Buildbucket for the build status
[22:19:38.520] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:19:38.520] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:96:0) after 1m0s
[22:20:38.525] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:96:0)
[22:20:38.525] Timer tick, asking Buildbucket for the build status
[22:20:38.572] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:20:38.572] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:97:0) after 1m0s
[22:21:38.558] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:97:0)
[22:21:38.558] Timer tick, asking Buildbucket for the build status
[22:21:38.598] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:21:38.598] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:98:0) after 1m0s
[22:22:38.605] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:98:0)
[22:22:38.605] Timer tick, asking Buildbucket for the build status
[22:22:38.826] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:22:38.827] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:99:0) after 1m0s
[22:23:38.848] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:99:0)
[22:23:38.848] Timer tick, asking Buildbucket for the build status
[22:23:38.915] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:23:38.915] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:100:0) after 1m0s
[22:24:38.945] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:100:0)
[22:24:38.945] Timer tick, asking Buildbucket for the build status
[22:24:39.012] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:24:39.012] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:101:0) after 1m0s
[22:25:39.011] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:101:0)
[22:25:39.011] Timer tick, asking Buildbucket for the build status
[22:25:39.044] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:25:39.044] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:102:0) after 1m0s
[22:26:39.096] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:102:0)
[22:26:39.096] Timer tick, asking Buildbucket for the build status
[22:26:39.161] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:26:39.161] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:103:0) after 1m0s
[22:27:39.189] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:103:0)
[22:27:39.189] Timer tick, asking Buildbucket for the build status
[22:27:39.243] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:27:39.243] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:104:0) after 1m0s
[22:28:39.251] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:104:0)
[22:28:39.251] Timer tick, asking Buildbucket for the build status
[22:28:39.305] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:28:39.305] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:105:0) after 1m0s
[22:29:39.278] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:105:0)
[22:29:39.278] Timer tick, asking Buildbucket for the build status
[22:29:39.337] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:29:39.337] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:106:0) after 1m0s
[22:30:39.357] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:106:0)
[22:30:39.357] Timer tick, asking Buildbucket for the build status
[22:30:39.413] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:30:39.413] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:107:0) after 1m0s
[22:31:39.435] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:107:0)
[22:31:39.435] Timer tick, asking Buildbucket for the build status
[22:31:39.530] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:31:39.530] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:108:0) after 1m0s
[22:32:39.555] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:108:0)
[22:32:39.555] Timer tick, asking Buildbucket for the build status
[22:32:40.062] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:32:40.062] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:109:0) after 1m0s
[22:33:40.092] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:109:0)
[22:33:40.092] Timer tick, asking Buildbucket for the build status
[22:33:40.159] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:33:40.160] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:110:0) after 1m0s
[22:34:40.186] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:110:0)
[22:34:40.186] Timer tick, asking Buildbucket for the build status
[22:34:40.285] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:34:40.285] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:111:0) after 1m0s
[22:35:40.310] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:111:0)
[22:35:40.310] Timer tick, asking Buildbucket for the build status
[22:35:40.375] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:35:40.375] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:112:0) after 1m0s
[22:36:40.389] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:112:0)
[22:36:40.389] Timer tick, asking Buildbucket for the build status
[22:36:40.478] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:36:40.478] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:113:0) after 1m0s
[22:37:40.502] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:113:0)
[22:37:40.502] Timer tick, asking Buildbucket for the build status
[22:37:40.655] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:37:40.655] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:114:0) after 1m0s
[22:38:40.635] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:114:0)
[22:38:40.635] Timer tick, asking Buildbucket for the build status
[22:38:40.680] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:38:40.680] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:115:0) after 1m0s
[22:39:40.705] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:115:0)
[22:39:40.705] Timer tick, asking Buildbucket for the build status
[22:39:40.767] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:39:40.767] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:116:0) after 1m0s
[22:40:40.801] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:116:0)
[22:40:40.801] Timer tick, asking Buildbucket for the build status
[22:40:40.860] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:40:40.860] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:117:0) after 1m0s
[22:41:40.881] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:117:0)
[22:41:40.881] Timer tick, asking Buildbucket for the build status
[22:41:41.133] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:41:41.133] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:118:0) after 1m0s
[22:42:41.155] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:118:0)
[22:42:41.155] Timer tick, asking Buildbucket for the build status
[22:42:41.201] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:42:41.201] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:119:0) after 1m0s
[22:43:41.204] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:119:0)
[22:43:41.204] Timer tick, asking Buildbucket for the build status
[22:43:41.279] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:43:41.279] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:120:0) after 1m0s
[22:44:41.301] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:120:0)
[22:44:41.301] Timer tick, asking Buildbucket for the build status
[22:44:41.364] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:44:41.364] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:121:0) after 1m0s
[22:45:41.380] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:121:0)
[22:45:41.380] Timer tick, asking Buildbucket for the build status
[22:45:41.485] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:45:41.485] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:122:0) after 1m0s
[22:46:41.497] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:122:0)
[22:46:41.497] Timer tick, asking Buildbucket for the build status
[22:46:41.577] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:46:41.577] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:123:0) after 1m0s
[22:47:41.575] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:123:0)
[22:47:41.575] Timer tick, asking Buildbucket for the build status
[22:47:41.630] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:47:41.630] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:124:0) after 1m0s
[22:48:41.657] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:124:0)
[22:48:41.657] Timer tick, asking Buildbucket for the build status
[22:48:41.741] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:48:41.741] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:125:0) after 1m0s
[22:49:41.800] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:125:0)
[22:49:41.800] Timer tick, asking Buildbucket for the build status
[22:49:41.837] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:49:41.837] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:126:0) after 1m0s
[22:50:41.862] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:126:0)
[22:50:41.862] Timer tick, asking Buildbucket for the build status
[22:50:41.902] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:50:41.902] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:127:0) after 1m0s
[22:51:41.925] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:127:0)
[22:51:41.925] Timer tick, asking Buildbucket for the build status
[22:51:41.968] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:51:41.968] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:128:0) after 1m0s
[22:52:41.987] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:128:0)
[22:52:41.987] Timer tick, asking Buildbucket for the build status
[22:52:42.123] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:52:42.123] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:129:0) after 1m0s
[22:53:42.154] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:129:0)
[22:53:42.154] Timer tick, asking Buildbucket for the build status
[22:53:42.193] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:53:42.193] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:130:0) after 1m0s
[22:54:42.300] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:130:0)
[22:54:42.300] Timer tick, asking Buildbucket for the build status
[22:54:42.411] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:54:42.411] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:131:0) after 1m0s
[22:55:42.449] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:131:0)
[22:55:42.449] Timer tick, asking Buildbucket for the build status
[22:55:42.501] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:55:42.501] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:132:0) after 1m0s
[22:56:42.512] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:132:0)
[22:56:42.512] Timer tick, asking Buildbucket for the build status
[22:56:42.561] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:56:42.561] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:133:0) after 1m0s
[22:57:42.630] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:133:0)
[22:57:42.630] Timer tick, asking Buildbucket for the build status
[22:57:42.687] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:57:42.687] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:134:0) after 1m0s
[22:58:42.714] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:134:0)
[22:58:42.714] Timer tick, asking Buildbucket for the build status
[22:58:42.860] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:58:42.860] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:135:0) after 1m0s
[22:59:42.908] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:135:0)
[22:59:42.908] Timer tick, asking Buildbucket for the build status
[22:59:42.945] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:42.945] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:136:0) after 1m0s
[23:00:42.973] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:136:0)
[23:00:42.973] Timer tick, asking Buildbucket for the build status
[23:00:43.016] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:00:43.016] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:137:0) after 1m0s
[23:01:42.999] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:137:0)
[23:01:42.999] Timer tick, asking Buildbucket for the build status
[23:01:43.039] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:01:43.039] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:138:0) after 1m0s
[23:02:43.033] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:138:0)
[23:02:43.033] Timer tick, asking Buildbucket for the build status
[23:02:43.097] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:02:43.097] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:139:0) after 1m0s
[23:03:43.074] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:139:0)
[23:03:43.074] Timer tick, asking Buildbucket for the build status
[23:03:43.132] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:03:43.132] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:140:0) after 1m0s
[23:04:43.164] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:140:0)
[23:04:43.164] Timer tick, asking Buildbucket for the build status
[23:04:43.201] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:04:43.201] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:141:0) after 1m0s
[23:05:43.205] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:141:0)
[23:05:43.205] Timer tick, asking Buildbucket for the build status
[23:05:43.262] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:43.262] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:142:0) after 1m0s
[23:06:43.268] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:142:0)
[23:06:43.268] Timer tick, asking Buildbucket for the build status
[23:06:43.630] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:43.630] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:143:0) after 1m0s
[23:07:43.610] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:143:0)
[23:07:43.610] Timer tick, asking Buildbucket for the build status
[23:07:43.644] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:43.644] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:144:0) after 1m0s
[23:08:43.664] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:144:0)
[23:08:43.664] Timer tick, asking Buildbucket for the build status
[23:08:43.792] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:43.792] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:145:0) after 1m0s
[23:09:43.800] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:145:0)
[23:09:43.800] Timer tick, asking Buildbucket for the build status
[23:09:43.921] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:43.921] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:146:0) after 1m0s
[23:10:43.946] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:146:0)
[23:10:43.946] Timer tick, asking Buildbucket for the build status
[23:10:44.061] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:44.062] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:147:0) after 1m0s
[23:11:44.068] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:147:0)
[23:11:44.068] Timer tick, asking Buildbucket for the build status
[23:11:44.103] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:44.103] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:148:0) after 1m0s
[23:12:44.136] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:148:0)
[23:12:44.136] Timer tick, asking Buildbucket for the build status
[23:12:44.199] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:44.199] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:149:0) after 1m0s
[23:13:44.263] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:149:0)
[23:13:44.263] Timer tick, asking Buildbucket for the build status
[23:13:44.316] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:44.316] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:150:0) after 1m0s
[23:14:44.341] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:150:0)
[23:14:44.341] Timer tick, asking Buildbucket for the build status
[23:14:44.469] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:44.469] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:151:0) after 1m0s
[23:15:44.464] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:151:0)
[23:15:44.464] Timer tick, asking Buildbucket for the build status
[23:15:44.675] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:44.675] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:152:0) after 1m0s
[23:16:44.697] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:152:0)
[23:16:44.697] Timer tick, asking Buildbucket for the build status
[23:16:44.738] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:44.738] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:153:0) after 1m0s
[23:17:44.762] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:153:0)
[23:17:44.762] Timer tick, asking Buildbucket for the build status
[23:17:44.928] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:44.928] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:154:0) after 1m0s
[23:18:44.968] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:154:0)
[23:18:44.968] Timer tick, asking Buildbucket for the build status
[23:18:45.008] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:45.008] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:155:0) after 1m0s
[23:19:45.019] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:155:0)
[23:19:45.019] Timer tick, asking Buildbucket for the build status
[23:19:45.077] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:45.077] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:156:0) after 1m0s
[23:20:45.087] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:156:0)
[23:20:45.087] Timer tick, asking Buildbucket for the build status
[23:20:45.130] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:45.130] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:157:0) after 1m0s
[23:21:45.142] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:157:0)
[23:21:45.142] Timer tick, asking Buildbucket for the build status
[23:21:45.200] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:45.200] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:158:0) after 1m0s
[23:22:45.228] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:158:0)
[23:22:45.228] Timer tick, asking Buildbucket for the build status
[23:22:45.374] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:45.374] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:159:0) after 1m0s
[23:23:45.369] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:159:0)
[23:23:45.369] Timer tick, asking Buildbucket for the build status
[23:23:45.501] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:45.501] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:160:0) after 1m0s
[23:24:45.529] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:160:0)
[23:24:45.529] Timer tick, asking Buildbucket for the build status
[23:24:45.646] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:45.646] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:161:0) after 1m0s
[23:25:45.676] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:161:0)
[23:25:45.676] Timer tick, asking Buildbucket for the build status
[23:25:45.712] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:45.712] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:162:0) after 1m0s
[23:26:45.737] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:162:0)
[23:26:45.737] Timer tick, asking Buildbucket for the build status
[23:26:45.776] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:45.776] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:163:0) after 1m0s
[23:27:45.800] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:163:0)
[23:27:45.800] Timer tick, asking Buildbucket for the build status
[23:27:45.982] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:45.982] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:164:0) after 1m0s
[23:28:46.012] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:164:0)
[23:28:46.012] Timer tick, asking Buildbucket for the build status
[23:28:46.049] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:46.049] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:165:0) after 1m0s
[23:29:46.072] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:165:0)
[23:29:46.072] Timer tick, asking Buildbucket for the build status
[23:29:46.299] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:46.299] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:166:0) after 1m0s
[23:30:46.330] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:166:0)
[23:30:46.330] Timer tick, asking Buildbucket for the build status
[23:30:46.385] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:46.385] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:167:0) after 1m0s
[23:31:46.411] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:167:0)
[23:31:46.411] Timer tick, asking Buildbucket for the build status
[23:31:46.461] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:46.461] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:168:0) after 1m0s
[23:32:46.466] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:168:0)
[23:32:46.466] Timer tick, asking Buildbucket for the build status
[23:32:46.551] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:46.551] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:169:0) after 1m0s
[23:33:46.596] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:169:0)
[23:33:46.596] Timer tick, asking Buildbucket for the build status
[23:33:46.786] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:46.786] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:170:0) after 1m0s
[23:34:46.813] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:170:0)
[23:34:46.813] Timer tick, asking Buildbucket for the build status
[23:34:46.852] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:46.852] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:171:0) after 1m0s
[23:35:46.874] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:171:0)
[23:35:46.874] Timer tick, asking Buildbucket for the build status
[23:35:46.943] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:46.943] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:172:0) after 1m0s
[23:36:46.968] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:172:0)
[23:36:46.968] Timer tick, asking Buildbucket for the build status
[23:36:47.079] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:47.079] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:173:0) after 1m0s
[23:37:47.106] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:173:0)
[23:37:47.106] Timer tick, asking Buildbucket for the build status
[23:37:47.276] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:37:47.276] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:174:0) after 1m0s
[23:38:47.270] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:174:0)
[23:38:47.270] Timer tick, asking Buildbucket for the build status
[23:38:47.362] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:38:47.362] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:175:0) after 1m0s
[23:39:47.362] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:175:0)
[23:39:47.362] Timer tick, asking Buildbucket for the build status
[23:39:47.405] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:47.405] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:176:0) after 1m0s
[23:40:47.432] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:176:0)
[23:40:47.432] Timer tick, asking Buildbucket for the build status
[23:40:47.501] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:47.501] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:177:0) after 1m0s
[23:41:47.522] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:177:0)
[23:41:47.522] Timer tick, asking Buildbucket for the build status
[23:41:47.560] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:41:47.560] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:178:0) after 1m0s
[23:42:47.557] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:178:0)
[23:42:47.557] Timer tick, asking Buildbucket for the build status
[23:42:47.599] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:42:47.599] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:179:0) after 1m0s
[23:43:47.594] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:179:0)
[23:43:47.594] Timer tick, asking Buildbucket for the build status
[23:43:47.629] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:43:47.629] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:180:0) after 1m0s
[23:44:47.647] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:180:0)
[23:44:47.647] Timer tick, asking Buildbucket for the build status
[23:44:47.770] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:44:47.771] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:181:0) after 1m0s
[23:45:47.790] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:181:0)
[23:45:47.790] Timer tick, asking Buildbucket for the build status
[23:45:47.887] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:45:47.887] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:182:0) after 1m0s
[23:46:47.905] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:182:0)
[23:46:47.905] Timer tick, asking Buildbucket for the build status
[23:46:47.949] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:46:47.949] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:183:0) after 1m0s
[23:47:47.975] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:183:0)
[23:47:47.975] Timer tick, asking Buildbucket for the build status
[23:47:48.043] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:47:48.043] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:184:0) after 1m0s
[23:48:48.069] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:184:0)
[23:48:48.069] Timer tick, asking Buildbucket for the build status
[23:48:48.104] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:48:48.104] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:185:0) after 1m0s
[23:49:48.151] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:185:0)
[23:49:48.151] Timer tick, asking Buildbucket for the build status
[23:49:48.195] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:49:48.195] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:186:0) after 1m0s
[23:50:48.223] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:186:0)
[23:50:48.223] Timer tick, asking Buildbucket for the build status
[23:50:48.255] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:50:48.256] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:187:0) after 1m0s
[23:51:48.281] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:187:0)
[23:51:48.281] Timer tick, asking Buildbucket for the build status
[23:51:48.314] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:51:48.314] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:188:0) after 1m0s
[23:52:48.351] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:188:0)
[23:52:48.351] Timer tick, asking Buildbucket for the build status
[23:52:48.389] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:52:48.389] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:189:0) after 1m0s
[23:53:48.427] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:189:0)
[23:53:48.427] Timer tick, asking Buildbucket for the build status
[23:53:48.464] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:48.464] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:190:0) after 1m0s
[23:54:48.491] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:190:0)
[23:54:48.491] Timer tick, asking Buildbucket for the build status
[23:54:48.624] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:48.624] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:191:0) after 1m0s
[23:55:48.649] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:191:0)
[23:55:48.649] Timer tick, asking Buildbucket for the build status
[23:55:48.684] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:48.684] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:192:0) after 1m0s
[23:56:48.673] Handling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:192:0)
[23:56:48.673] Timer tick, asking Buildbucket for the build status
[23:56:48.707] Build 8919069007568537984: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:48.707] Scheduling timer "check-buildbucket-build-status" (chromium/Windows deterministic:9084499069549926928:193:0) after 1m0s
[23:56:55.182] Received PubSub notification, asking Buildbucket for the build status
[23:56:55.241] Build 8919069007568537984: status "COMPLETED", result "FAILURE", failure_reason "INFRA_FAILURE", cancelation_reason ""
[23:56:55.241] Buildbucket build:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "AUTO",
    "completed_ts": "1552521414754019",
    "created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
    "created_ts": "1552509983434423",
    "failure_reason": "INFRA_FAILURE",
    "id": "8919069007568537984",
    "parameters_json": "{\"builder_name\": \"Windows deterministic\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"e6b703611b2ee011be434da39e5272d3ad21ca7c\"}}",
    "project": "chromium",
    "result": "FAILURE",
    "result_details_json": "{\"swarming\": {\"bot_dimensions\": {\"gce\": [\"1\"], \"machine_type\": [\"n1-standard-8\"], \"zone\": [\"us\", \"us-west\", \"us-west1\", \"us-west1-b\"], \"locale\": [\"en_US.cp1252\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"builder\": [\"Windows deterministic\"], \"id\": [\"win10-727f49a0-us-west1-b-kb2j\"], \"python\": [\"2.7.13\"], \"server_version\": [\"4186-af94c3f\"], \"image\": [\"chrome-win10-1703-2018-04-20-61acaf8983f\"], \"gpu\": [\"none\"], \"cores\": [\"8\"], \"integrity\": [\"high\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\"], \"pool\": [\"luci.chromium.ci\"], \"caches\": [\"builder_e8fffaf9fac16164b1ec16ebaa1f377b792d39a582f7640830518d8ff7303d0c_v2\", \"git\", \"goma_v2\", \"vpython\"]}}, \"ui\": {\"info\": \"\"}, \"properties\": {\"$recipe_engine/path\": {\"cache_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\cache\", \"temp_dir\": \"C:\\\\b\\\\s\\\\w\\\\ir\\\\tmp\\\\rt\"}, \"got_angle_revision\": \"4e87659e289c37602e3c94264e7302fe7a8dfaa7\", \"got_nacl_revision\": \"1ed9878b8eb68c1e0d0268754dafcf83e747fa8f\", \"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"buildername\": \"Windows deterministic\", \"got_revision_cp\": \"refs/heads/master@{#640472}\", \"got_webrtc_revision\": \"cc3503248f1dc7edd3ab505b5194c69718d0f711\", \"got_revision\": \"e6b703611b2ee011be434da39e5272d3ad21ca7c\", \"got_swarming_client_revision\": \"7a61cf37d6a0163f0ec02d495289a1d038e62457\", \"recipe\": \"swarming/deterministic_build\", \"mastername\": \"chromium.win\", \"buildnumber\": 12416, \"got_v8_revision\": \"f7cc35d707c060d94ce8d3ef4855055752ceea42\", \"got_v8_revision_cp\": \"refs/heads/7.5.29@{#1}\", \"got_dawn_revision\": \"ea2c7f20f2f96e15570f7e9416fb6c826f809747\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#27098}\", \"path_config\": \"generic\", \"bot_id\": \"win10-727f49a0-us-west1-b-kb2j\", \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"revision\": \"e6b703611b2ee011be434da39e5272d3ad21ca7c\"}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1552510083025304",
    "status": "COMPLETED",
    "status_changed_ts": "1552521415020426",
    "tags": [
      "build_address:luci.chromium.ci/Windows deterministic/12416",
      "builder:Windows deterministic",
      "buildset:commit/git/e6b703611b2ee011be434da39e5272d3ad21ca7c",
      "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/e6b703611b2ee011be434da39e5272d3ad21ca7c",
      "gitiles_ref:refs/heads/master",
      "scheduler_invocation_id:9084499069549926928",
      "scheduler_job_id:chromium/Windows deterministic",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8919069007568537984/+/annotations",
      "swarming_tag:luci_project:chromium",
      "swarming_tag:os:Windows",
      "swarming_tag:recipe_name:swarming/deterministic_build",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
      "swarming_task_id:43919fe53d1d6210",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1552521415024272",
    "url": "https://ci.chromium.org/b/8919069007568537984",
    "utcnow_ts": "1552521415232946"
  }
}
[23:56:55.241] Invocation finished in 3h10m33.080321824s with status FAILED