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

• cron:v1:4955 (5 years ago)

[04:33:08.492] New invocation is queued and will start shortly
[04:33:09.593] Starting the invocation (attempt 1)
[04:33:09.673] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[04:33:09.673] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[04:33:09.673] Buildbucket request:
{
  "bucket": "luci.chromium.ci",
  "client_operation_id": "9027484210937504224",
  "parameters_json": "{\"builder_name\":\"win-upload-perfetto\",\"properties\":{}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:win-upload-perfetto",
    "scheduler_invocation_id:9027484210937504224",
    "scheduler_job_id:chromium/win-upload-perfetto",
    "user_agent:luci-scheduler"
  ]
}
[04:33:10.497] Buildbucket response:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "created_by": "project:chromium",
    "created_ts": "1606883589824402",
    "id": "8862054148875388544",
    "parameters_json": "{\"builder_name\": \"win-upload-perfetto\", \"properties\": {}}",
    "project": "chromium",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1606883590286261",
    "tags": [
      "build_address:luci.chromium.ci/win-upload-perfetto/1807",
      "builder:win-upload-perfetto",
      "scheduler_invocation_id:9027484210937504224",
      "scheduler_job_id:chromium/win-upload-perfetto",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8862054148875388544/+/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": "1606883590286435",
    "url": "https://ci.chromium.org/b/8862054148875388544",
    "utcnow_ts": "1606883590478531"
  }
}
[04:33:10.497] Task URL: https://ci.chromium.org/b/8862054148875388544
[04:33:10.497] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:2:0) after 1m0s
[04:34:10.667] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:2:0)
[04:34:10.667] Timer tick, asking Buildbucket for the build status
[04:34:10.973] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:34:10.973] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:3:0) after 1m0s
[04:35:11.052] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:3:0)
[04:35:11.052] Timer tick, asking Buildbucket for the build status
[04:35:11.286] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:35:11.287] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:4:0) after 1m0s
[04:36:11.371] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:4:0)
[04:36:11.371] Timer tick, asking Buildbucket for the build status
[04:36:11.809] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:36:11.809] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:5:0) after 1m0s
[04:37:11.888] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:5:0)
[04:37:11.888] Timer tick, asking Buildbucket for the build status
[04:37:11.996] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:37:11.996] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:6:0) after 1m0s
[04:38:12.084] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:6:0)
[04:38:12.084] Timer tick, asking Buildbucket for the build status
[04:38:12.247] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:38:12.247] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:7:0) after 1m0s
[04:39:12.305] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:7:0)
[04:39:12.305] Timer tick, asking Buildbucket for the build status
[04:39:12.813] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:39:12.813] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:8:0) after 1m0s
[04:40:12.871] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:8:0)
[04:40:12.871] Timer tick, asking Buildbucket for the build status
[04:40:12.975] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:40:12.980] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:9:0) after 1m0s
[04:41:13.028] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:9:0)
[04:41:13.028] Timer tick, asking Buildbucket for the build status
[04:41:13.108] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:41:13.108] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:10:0) after 1m0s
[04:42:13.168] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:10:0)
[04:42:13.168] Timer tick, asking Buildbucket for the build status
[04:42:13.252] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:42:13.252] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:11:0) after 1m0s
[04:43:13.531] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:11:0)
[04:43:13.531] Timer tick, asking Buildbucket for the build status
[04:43:13.654] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:43:13.654] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:12:0) after 1m0s
[04:44:13.831] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:12:0)
[04:44:13.832] Timer tick, asking Buildbucket for the build status
[04:44:14.024] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:44:14.024] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:13:0) after 1m0s
[04:45:14.147] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:13:0)
[04:45:14.147] Timer tick, asking Buildbucket for the build status
[04:45:14.243] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:45:14.243] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:14:0) after 1m0s
[04:46:14.378] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:14:0)
[04:46:14.378] Timer tick, asking Buildbucket for the build status
[04:46:14.666] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:46:14.666] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:15:0) after 1m0s
[04:47:14.695] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:15:0)
[04:47:14.695] Timer tick, asking Buildbucket for the build status
[04:47:14.889] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:47:14.889] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:16:0) after 1m0s
[04:48:14.979] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:16:0)
[04:48:14.979] Timer tick, asking Buildbucket for the build status
[04:48:15.094] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:48:15.094] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:17:0) after 1m0s
[04:49:15.111] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:17:0)
[04:49:15.111] Timer tick, asking Buildbucket for the build status
[04:49:15.412] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:49:15.412] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:18:0) after 1m0s
[04:50:15.483] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:18:0)
[04:50:15.483] Timer tick, asking Buildbucket for the build status
[04:50:15.864] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:50:15.864] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:19:0) after 1m0s
[04:51:15.935] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:19:0)
[04:51:15.935] Timer tick, asking Buildbucket for the build status
[04:51:16.028] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:51:16.028] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:20:0) after 1m0s
[04:52:16.101] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:20:0)
[04:52:16.101] Timer tick, asking Buildbucket for the build status
[04:52:16.214] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:52:16.214] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:21:0) after 1m0s
[04:53:16.338] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:21:0)
[04:53:16.338] Timer tick, asking Buildbucket for the build status
[04:53:16.795] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:53:16.795] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:22:0) after 1m0s
[04:54:16.983] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:22:0)
[04:54:16.983] Timer tick, asking Buildbucket for the build status
[04:54:17.112] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:54:17.112] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:23:0) after 1m0s
[04:55:17.316] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:23:0)
[04:55:17.316] Timer tick, asking Buildbucket for the build status
[04:55:17.523] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:55:17.523] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:24:0) after 1m0s
[04:56:17.697] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:24:0)
[04:56:17.697] Timer tick, asking Buildbucket for the build status
[04:56:17.774] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:56:17.774] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:25:0) after 1m0s
[04:57:17.797] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:25:0)
[04:57:17.797] Timer tick, asking Buildbucket for the build status
[04:57:17.938] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:57:17.938] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:26:0) after 1m0s
[04:58:17.967] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:26:0)
[04:58:17.967] Timer tick, asking Buildbucket for the build status
[04:58:18.159] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:58:18.159] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:27:0) after 1m0s
[04:59:18.185] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:27:0)
[04:59:18.185] Timer tick, asking Buildbucket for the build status
[04:59:18.518] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:59:18.518] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:28:0) after 1m0s
[05:00:18.612] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:28:0)
[05:00:18.612] Timer tick, asking Buildbucket for the build status
[05:00:19.015] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:00:19.015] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:29:0) after 1m0s
[05:01:29.790] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:29:0)
[05:01:29.790] Timer tick, asking Buildbucket for the build status
[05:01:32.999] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:01:33.003] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:30:0) after 1m0s
[05:02:33.186] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:30:0)
[05:02:33.186] Timer tick, asking Buildbucket for the build status
[05:02:33.457] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:02:33.457] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:31:0) after 1m0s
[05:03:33.465] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:31:0)
[05:03:33.465] Timer tick, asking Buildbucket for the build status
[05:03:33.623] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:03:33.623] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:32:0) after 1m0s
[05:04:33.613] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:32:0)
[05:04:33.613] Timer tick, asking Buildbucket for the build status
[05:04:33.693] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:04:33.693] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:33:0) after 1m0s
[05:05:33.770] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:33:0)
[05:05:33.770] Timer tick, asking Buildbucket for the build status
[05:05:33.860] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:05:33.860] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:34:0) after 1m0s
[05:06:33.912] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:34:0)
[05:06:33.912] Timer tick, asking Buildbucket for the build status
[05:06:34.155] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:06:34.155] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:35:0) after 1m0s
[05:07:34.237] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:35:0)
[05:07:34.237] Timer tick, asking Buildbucket for the build status
[05:07:34.302] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:07:34.302] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:36:0) after 1m0s
[05:08:34.368] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:36:0)
[05:08:34.368] Timer tick, asking Buildbucket for the build status
[05:08:34.468] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:08:34.468] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:37:0) after 1m0s
[05:09:34.505] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:37:0)
[05:09:34.505] Timer tick, asking Buildbucket for the build status
[05:09:34.601] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:09:34.601] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:38:0) after 1m0s
[05:10:34.616] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:38:0)
[05:10:34.616] Timer tick, asking Buildbucket for the build status
[05:10:34.923] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:10:34.923] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:39:0) after 1m0s
[05:11:34.969] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:39:0)
[05:11:34.969] Timer tick, asking Buildbucket for the build status
[05:11:35.145] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:11:35.145] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:40:0) after 1m0s
[05:12:35.355] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:40:0)
[05:12:35.356] Timer tick, asking Buildbucket for the build status
[05:12:35.480] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:12:35.480] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:41:0) after 1m0s
[05:13:35.512] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:41:0)
[05:13:35.512] Timer tick, asking Buildbucket for the build status
[05:13:35.946] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:13:35.946] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:42:0) after 1m0s
[05:14:36.012] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:42:0)
[05:14:36.012] Timer tick, asking Buildbucket for the build status
[05:14:36.161] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:14:36.161] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:43:0) after 1m0s
[05:15:36.171] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:43:0)
[05:15:36.171] Timer tick, asking Buildbucket for the build status
[05:15:36.441] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:15:36.441] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:44:0) after 1m0s
[05:16:36.476] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:44:0)
[05:16:36.476] Timer tick, asking Buildbucket for the build status
[05:16:36.592] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:16:36.592] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:45:0) after 1m0s
[05:17:36.623] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:45:0)
[05:17:36.623] Timer tick, asking Buildbucket for the build status
[05:17:36.728] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:17:36.728] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:46:0) after 1m0s
[05:18:36.754] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:46:0)
[05:18:36.754] Timer tick, asking Buildbucket for the build status
[05:18:36.839] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:18:36.839] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:47:0) after 1m0s
[05:19:36.904] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:47:0)
[05:19:36.904] Timer tick, asking Buildbucket for the build status
[05:19:37.053] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:19:37.053] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:48:0) after 1m0s
[05:20:37.238] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:48:0)
[05:20:37.238] Timer tick, asking Buildbucket for the build status
[05:20:37.326] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:20:37.326] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:49:0) after 1m0s
[05:21:37.394] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:49:0)
[05:21:37.394] Timer tick, asking Buildbucket for the build status
[05:21:37.473] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:21:37.473] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:50:0) after 1m0s
[05:22:37.567] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:50:0)
[05:22:37.567] Timer tick, asking Buildbucket for the build status
[05:22:37.723] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:22:37.723] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:51:0) after 1m0s
[05:23:37.784] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:51:0)
[05:23:37.784] Timer tick, asking Buildbucket for the build status
[05:23:37.953] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:23:37.953] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:52:0) after 1m0s
[05:24:38.027] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:52:0)
[05:24:38.027] Timer tick, asking Buildbucket for the build status
[05:24:38.108] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:24:38.108] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:53:0) after 1m0s
[05:25:38.158] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:53:0)
[05:25:38.158] Timer tick, asking Buildbucket for the build status
[05:25:38.250] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:25:38.250] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:54:0) after 1m0s
[05:26:38.606] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:54:0)
[05:26:38.607] Timer tick, asking Buildbucket for the build status
[05:26:38.689] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:26:38.689] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:55:0) after 1m0s
[05:27:38.780] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:55:0)
[05:27:38.780] Timer tick, asking Buildbucket for the build status
[05:27:38.869] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:27:38.869] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:56:0) after 1m0s
[05:28:39.000] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:56:0)
[05:28:39.000] Timer tick, asking Buildbucket for the build status
[05:28:39.142] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:28:39.142] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:57:0) after 1m0s
[05:29:39.312] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:57:0)
[05:29:39.312] Timer tick, asking Buildbucket for the build status
[05:29:39.428] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:29:39.428] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:58:0) after 1m0s
[05:30:40.607] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:58:0)
[05:30:40.607] Timer tick, asking Buildbucket for the build status
[05:30:40.675] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:30:40.675] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:59:0) after 1m0s
[05:31:41.009] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:59:0)
[05:31:41.009] Timer tick, asking Buildbucket for the build status
[05:31:41.185] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:31:41.185] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:60:0) after 1m0s
[05:32:41.760] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:60:0)
[05:32:41.760] Timer tick, asking Buildbucket for the build status
[05:32:41.836] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:32:41.836] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:61:0) after 1m0s
[05:33:41.931] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:61:0)
[05:33:41.931] Timer tick, asking Buildbucket for the build status
[05:33:42.049] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:33:42.049] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:62:0) after 1m0s
[05:34:42.067] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:62:0)
[05:34:42.067] Timer tick, asking Buildbucket for the build status
[05:34:42.143] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:34:42.143] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:63:0) after 1m0s
[05:35:43.812] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:63:0)
[05:35:43.812] Timer tick, asking Buildbucket for the build status
[05:35:43.876] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:35:43.876] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:64:0) after 1m0s
[05:36:43.918] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:64:0)
[05:36:43.918] Timer tick, asking Buildbucket for the build status
[05:36:44.055] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:36:44.055] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:65:0) after 1m0s
[05:37:44.135] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:65:0)
[05:37:44.135] Timer tick, asking Buildbucket for the build status
[05:37:44.257] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:37:44.257] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:66:0) after 1m0s
[05:38:44.329] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:66:0)
[05:38:44.329] Timer tick, asking Buildbucket for the build status
[05:38:44.595] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:38:44.595] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:67:0) after 1m0s
[05:39:44.618] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:67:0)
[05:39:44.618] Timer tick, asking Buildbucket for the build status
[05:39:44.708] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:39:44.708] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:68:0) after 1m0s
[05:40:44.731] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:68:0)
[05:40:44.731] Timer tick, asking Buildbucket for the build status
[05:40:45.226] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:40:45.226] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:69:0) after 1m0s
[05:41:45.320] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:69:0)
[05:41:45.320] Timer tick, asking Buildbucket for the build status
[05:41:45.477] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:41:45.477] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:70:0) after 1m0s
[05:42:45.530] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:70:0)
[05:42:45.530] Timer tick, asking Buildbucket for the build status
[05:42:45.608] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:42:45.608] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:71:0) after 1m0s
[05:43:45.732] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:71:0)
[05:43:45.732] Timer tick, asking Buildbucket for the build status
[05:43:45.885] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:43:45.885] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:72:0) after 1m0s
[05:44:45.915] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:72:0)
[05:44:45.915] Timer tick, asking Buildbucket for the build status
[05:44:45.986] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:44:45.986] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:73:0) after 1m0s
[05:45:46.017] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:73:0)
[05:45:46.017] Timer tick, asking Buildbucket for the build status
[05:45:46.106] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:45:46.106] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:74:0) after 1m0s
[05:46:46.181] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:74:0)
[05:46:46.181] Timer tick, asking Buildbucket for the build status
[05:46:46.336] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:46:46.336] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:75:0) after 1m0s
[05:47:46.358] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:75:0)
[05:47:46.358] Timer tick, asking Buildbucket for the build status
[05:47:47.216] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:47:47.216] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:76:0) after 1m0s
[05:48:47.250] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:76:0)
[05:48:47.250] Timer tick, asking Buildbucket for the build status
[05:48:47.368] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:48:47.368] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:77:0) after 1m0s
[05:49:47.395] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:77:0)
[05:49:47.395] Timer tick, asking Buildbucket for the build status
[05:49:47.887] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:49:47.887] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:78:0) after 1m0s
[05:50:47.936] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:78:0)
[05:50:47.936] Timer tick, asking Buildbucket for the build status
[05:50:48.041] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:50:48.041] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:79:0) after 1m0s
[05:51:48.116] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:79:0)
[05:51:48.116] Timer tick, asking Buildbucket for the build status
[05:51:48.257] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:51:48.258] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:80:0) after 1m0s
[05:52:48.390] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:80:0)
[05:52:48.390] Timer tick, asking Buildbucket for the build status
[05:52:48.471] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:52:48.471] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:81:0) after 1m0s
[05:53:48.608] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:81:0)
[05:53:48.608] Timer tick, asking Buildbucket for the build status
[05:53:48.731] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:53:48.731] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:82:0) after 1m0s
[05:54:48.754] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:82:0)
[05:54:48.754] Timer tick, asking Buildbucket for the build status
[05:54:49.154] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:54:49.154] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:83:0) after 1m0s
[05:55:49.160] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:83:0)
[05:55:49.160] Timer tick, asking Buildbucket for the build status
[05:55:51.445] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:55:51.445] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:84:0) after 1m0s
[05:56:51.514] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:84:0)
[05:56:51.514] Timer tick, asking Buildbucket for the build status
[05:56:51.612] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:56:51.612] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:85:0) after 1m0s
[05:57:51.653] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:85:0)
[05:57:51.653] Timer tick, asking Buildbucket for the build status
[05:57:51.741] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:57:51.741] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:86:0) after 1m0s
[05:58:51.744] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:86:0)
[05:58:51.744] Timer tick, asking Buildbucket for the build status
[05:58:51.881] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:58:51.881] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:87:0) after 1m0s
[05:59:52.179] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:87:0)
[05:59:52.179] Timer tick, asking Buildbucket for the build status
[05:59:52.257] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[05:59:52.257] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:88:0) after 1m0s
[06:00:52.258] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:88:0)
[06:00:52.258] Timer tick, asking Buildbucket for the build status
[06:00:52.481] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:00:52.481] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:89:0) after 1m0s
[06:01:52.512] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:89:0)
[06:01:52.512] Timer tick, asking Buildbucket for the build status
[06:01:52.595] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:01:52.595] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:90:0) after 1m0s
[06:02:52.594] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:90:0)
[06:02:52.594] Timer tick, asking Buildbucket for the build status
[06:02:52.814] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:02:52.814] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:91:0) after 1m0s
[06:03:52.815] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:91:0)
[06:03:52.815] Timer tick, asking Buildbucket for the build status
[06:03:52.939] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:03:52.940] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:92:0) after 1m0s
[06:04:52.988] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:92:0)
[06:04:52.988] Timer tick, asking Buildbucket for the build status
[06:04:53.093] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:04:53.094] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:93:0) after 1m0s
[06:05:53.107] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:93:0)
[06:05:53.107] Timer tick, asking Buildbucket for the build status
[06:05:53.387] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:05:53.387] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:94:0) after 1m0s
[06:06:53.540] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:94:0)
[06:06:53.540] Timer tick, asking Buildbucket for the build status
[06:06:53.838] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:06:53.838] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:95:0) after 1m0s
[06:07:53.907] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:95:0)
[06:07:53.907] Timer tick, asking Buildbucket for the build status
[06:07:53.988] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:07:53.988] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:96:0) after 1m0s
[06:08:54.024] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:96:0)
[06:08:54.024] Timer tick, asking Buildbucket for the build status
[06:08:54.153] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:08:54.153] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:97:0) after 1m0s
[06:09:54.212] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:97:0)
[06:09:54.213] Timer tick, asking Buildbucket for the build status
[06:09:54.283] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:09:54.283] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:98:0) after 1m0s
[06:10:54.300] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:98:0)
[06:10:54.301] Timer tick, asking Buildbucket for the build status
[06:10:54.379] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:10:54.379] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:99:0) after 1m0s
[06:11:54.426] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:99:0)
[06:11:54.426] Timer tick, asking Buildbucket for the build status
[06:11:54.487] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:11:54.488] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:100:0) after 1m0s
[06:12:54.565] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:100:0)
[06:12:54.565] Timer tick, asking Buildbucket for the build status
[06:12:54.649] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:12:54.649] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:101:0) after 1m0s
[06:13:54.654] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:101:0)
[06:13:54.654] Timer tick, asking Buildbucket for the build status
[06:13:54.742] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:13:54.742] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:102:0) after 1m0s
[06:14:54.790] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:102:0)
[06:14:54.790] Timer tick, asking Buildbucket for the build status
[06:14:54.938] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:14:54.938] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:103:0) after 1m0s
[06:15:54.987] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:103:0)
[06:15:54.987] Timer tick, asking Buildbucket for the build status
[06:15:55.074] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:15:55.074] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:104:0) after 1m0s
[06:16:55.110] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:104:0)
[06:16:55.110] Timer tick, asking Buildbucket for the build status
[06:16:55.176] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:16:55.176] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:105:0) after 1m0s
[06:17:55.216] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:105:0)
[06:17:55.216] Timer tick, asking Buildbucket for the build status
[06:17:55.283] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:17:55.283] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:106:0) after 1m0s
[06:18:55.347] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:106:0)
[06:18:55.347] Timer tick, asking Buildbucket for the build status
[06:18:55.459] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:18:55.459] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:107:0) after 1m0s
[06:19:55.467] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:107:0)
[06:19:55.467] Timer tick, asking Buildbucket for the build status
[06:19:55.552] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:19:55.552] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:108:0) after 1m0s
[06:20:55.546] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:108:0)
[06:20:55.546] Timer tick, asking Buildbucket for the build status
[06:20:55.639] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:20:55.639] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:109:0) after 1m0s
[06:21:55.701] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:109:0)
[06:21:55.701] Timer tick, asking Buildbucket for the build status
[06:21:55.760] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:21:55.760] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:110:0) after 1m0s
[06:22:55.832] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:110:0)
[06:22:55.832] Timer tick, asking Buildbucket for the build status
[06:22:56.061] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:22:56.061] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:111:0) after 1m0s
[06:23:56.119] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:111:0)
[06:23:56.119] Timer tick, asking Buildbucket for the build status
[06:23:56.237] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:23:56.237] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:112:0) after 1m0s
[06:24:56.261] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:112:0)
[06:24:56.261] Timer tick, asking Buildbucket for the build status
[06:24:56.346] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:24:56.346] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:113:0) after 1m0s
[06:25:56.325] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:113:0)
[06:25:56.325] Timer tick, asking Buildbucket for the build status
[06:25:56.433] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:25:56.433] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:114:0) after 1m0s
[06:26:56.452] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:114:0)
[06:26:56.452] Timer tick, asking Buildbucket for the build status
[06:26:56.670] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:26:56.670] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:115:0) after 1m0s
[06:27:56.704] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:115:0)
[06:27:56.704] Timer tick, asking Buildbucket for the build status
[06:27:56.769] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:27:56.769] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:116:0) after 1m0s
[06:28:56.777] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:116:0)
[06:28:56.777] Timer tick, asking Buildbucket for the build status
[06:28:56.999] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:28:56.999] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:117:0) after 1m0s
[06:29:57.013] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:117:0)
[06:29:57.013] Timer tick, asking Buildbucket for the build status
[06:29:57.103] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:29:57.103] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:118:0) after 1m0s
[06:30:57.136] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:118:0)
[06:30:57.136] Timer tick, asking Buildbucket for the build status
[06:30:58.406] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:30:58.406] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:119:0) after 1m0s
[06:31:58.856] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:119:0)
[06:31:58.856] Timer tick, asking Buildbucket for the build status
[06:31:58.954] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:31:58.954] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:120:0) after 1m0s
[06:32:59.066] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:120:0)
[06:32:59.066] Timer tick, asking Buildbucket for the build status
[06:32:59.141] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:32:59.141] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:121:0) after 1m0s
[06:33:59.257] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:121:0)
[06:33:59.257] Timer tick, asking Buildbucket for the build status
[06:33:59.415] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:33:59.415] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:122:0) after 1m0s
[06:34:59.446] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:122:0)
[06:34:59.446] Timer tick, asking Buildbucket for the build status
[06:34:59.591] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:34:59.591] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:123:0) after 1m0s
[06:35:59.579] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:123:0)
[06:35:59.579] Timer tick, asking Buildbucket for the build status
[06:35:59.677] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:35:59.677] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:124:0) after 1m0s
[06:36:59.708] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:124:0)
[06:36:59.708] Timer tick, asking Buildbucket for the build status
[06:36:59.852] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:36:59.852] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:125:0) after 1m0s
[06:37:59.881] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:125:0)
[06:37:59.881] Timer tick, asking Buildbucket for the build status
[06:38:00.205] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:38:00.205] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:126:0) after 1m0s
[06:39:00.268] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:126:0)
[06:39:00.268] Timer tick, asking Buildbucket for the build status
[06:39:00.409] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:39:00.409] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:127:0) after 1m0s
[06:40:00.469] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:127:0)
[06:40:00.469] Timer tick, asking Buildbucket for the build status
[06:40:00.588] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:40:00.588] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:128:0) after 1m0s
[06:41:00.717] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:128:0)
[06:41:00.717] Timer tick, asking Buildbucket for the build status
[06:41:00.915] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:41:00.915] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:129:0) after 1m0s
[06:42:01.652] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:129:0)
[06:42:01.652] Timer tick, asking Buildbucket for the build status
[06:42:01.958] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:42:01.958] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:130:0) after 1m0s
[06:43:02.565] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:130:0)
[06:43:02.566] Timer tick, asking Buildbucket for the build status
[06:43:02.641] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:43:02.641] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:131:0) after 1m0s
[06:44:03.341] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:131:0)
[06:44:03.341] Timer tick, asking Buildbucket for the build status
[06:44:03.461] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:44:03.461] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:132:0) after 1m0s
[06:45:04.577] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:132:0)
[06:45:04.577] Timer tick, asking Buildbucket for the build status
[06:45:04.781] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:45:04.781] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:133:0) after 1m0s
[06:46:05.573] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:133:0)
[06:46:05.573] Timer tick, asking Buildbucket for the build status
[06:46:05.664] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:46:05.664] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:134:0) after 1m0s
[06:47:06.035] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:134:0)
[06:47:06.035] Timer tick, asking Buildbucket for the build status
[06:47:06.245] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:47:06.245] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:135:0) after 1m0s
[06:48:06.430] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:135:0)
[06:48:06.430] Timer tick, asking Buildbucket for the build status
[06:48:07.403] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:48:07.403] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:136:0) after 1m0s
[06:49:07.607] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:136:0)
[06:49:07.608] Timer tick, asking Buildbucket for the build status
[06:49:07.716] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:49:07.716] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:137:0) after 1m0s
[06:50:07.792] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:137:0)
[06:50:07.792] Timer tick, asking Buildbucket for the build status
[06:50:07.884] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:50:07.884] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:138:0) after 1m0s
[06:51:08.021] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:138:0)
[06:51:08.021] Timer tick, asking Buildbucket for the build status
[06:51:08.089] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:51:08.089] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:139:0) after 1m0s
[06:52:08.238] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:139:0)
[06:52:08.238] Timer tick, asking Buildbucket for the build status
[06:52:08.365] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:52:08.365] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:140:0) after 1m0s
[06:53:08.508] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:140:0)
[06:53:08.508] Timer tick, asking Buildbucket for the build status
[06:53:08.647] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:53:08.647] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:141:0) after 1m0s
[06:54:08.750] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:141:0)
[06:54:08.750] Timer tick, asking Buildbucket for the build status
[06:54:09.102] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:54:09.102] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:142:0) after 1m0s
[06:55:09.191] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:142:0)
[06:55:09.191] Timer tick, asking Buildbucket for the build status
[06:55:09.291] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:55:09.291] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:143:0) after 1m0s
[06:56:09.359] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:143:0)
[06:56:09.359] Timer tick, asking Buildbucket for the build status
[06:56:09.434] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:56:09.434] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:144:0) after 1m0s
[06:57:09.488] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:144:0)
[06:57:09.488] Timer tick, asking Buildbucket for the build status
[06:57:10.047] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:57:10.047] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:145:0) after 1m0s
[06:58:10.089] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:145:0)
[06:58:10.089] Timer tick, asking Buildbucket for the build status
[06:58:10.386] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:58:10.386] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:146:0) after 1m0s
[06:59:10.447] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:146:0)
[06:59:10.447] Timer tick, asking Buildbucket for the build status
[06:59:10.581] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[06:59:10.581] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:147:0) after 1m0s
[07:00:10.685] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:147:0)
[07:00:10.685] Timer tick, asking Buildbucket for the build status
[07:00:10.769] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:00:10.769] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:148:0) after 1m0s
[07:01:10.959] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:148:0)
[07:01:10.959] Timer tick, asking Buildbucket for the build status
[07:01:11.089] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:01:11.089] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:149:0) after 1m0s
[07:02:11.238] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:149:0)
[07:02:11.238] Timer tick, asking Buildbucket for the build status
[07:02:11.328] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:02:11.328] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:150:0) after 1m0s
[07:03:11.486] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:150:0)
[07:03:11.486] Timer tick, asking Buildbucket for the build status
[07:03:11.581] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:03:11.581] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:151:0) after 1m0s
[07:04:11.725] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:151:0)
[07:04:11.725] Timer tick, asking Buildbucket for the build status
[07:04:11.828] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:04:11.828] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:152:0) after 1m0s
[07:05:11.890] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:152:0)
[07:05:11.890] Timer tick, asking Buildbucket for the build status
[07:05:11.982] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:05:11.986] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:153:0) after 1m0s
[07:06:12.072] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:153:0)
[07:06:12.072] Timer tick, asking Buildbucket for the build status
[07:06:12.157] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:06:12.157] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:154:0) after 1m0s
[07:07:12.230] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:154:0)
[07:07:12.230] Timer tick, asking Buildbucket for the build status
[07:07:12.458] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:07:12.458] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:155:0) after 1m0s
[07:08:12.571] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:155:0)
[07:08:12.571] Timer tick, asking Buildbucket for the build status
[07:08:13.692] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:08:13.692] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:156:0) after 1m0s
[07:09:13.797] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:156:0)
[07:09:13.797] Timer tick, asking Buildbucket for the build status
[07:09:14.066] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:09:14.066] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:157:0) after 1m0s
[07:10:14.135] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:157:0)
[07:10:14.135] Timer tick, asking Buildbucket for the build status
[07:10:14.218] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:10:14.218] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:158:0) after 1m0s
[07:11:14.276] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:158:0)
[07:11:14.276] Timer tick, asking Buildbucket for the build status
[07:11:15.421] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:11:15.421] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:159:0) after 1m0s
[07:12:15.416] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:159:0)
[07:12:15.416] Timer tick, asking Buildbucket for the build status
[07:12:15.513] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:12:15.513] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:160:0) after 1m0s
[07:13:15.539] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:160:0)
[07:13:15.539] Timer tick, asking Buildbucket for the build status
[07:13:15.621] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:13:15.621] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:161:0) after 1m0s
[07:14:15.680] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:161:0)
[07:14:15.680] Timer tick, asking Buildbucket for the build status
[07:14:15.805] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:14:15.806] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:162:0) after 1m0s
[07:15:15.819] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:162:0)
[07:15:15.819] Timer tick, asking Buildbucket for the build status
[07:15:16.464] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:15:16.465] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:163:0) after 1m0s
[07:16:16.546] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:163:0)
[07:16:16.546] Timer tick, asking Buildbucket for the build status
[07:16:16.840] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:16:16.840] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:164:0) after 1m0s
[07:17:16.905] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:164:0)
[07:17:16.905] Timer tick, asking Buildbucket for the build status
[07:17:17.082] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:17:17.082] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:165:0) after 1m0s
[07:18:17.132] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:165:0)
[07:18:17.132] Timer tick, asking Buildbucket for the build status
[07:18:17.222] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:18:17.222] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:166:0) after 1m0s
[07:19:17.323] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:166:0)
[07:19:17.323] Timer tick, asking Buildbucket for the build status
[07:19:17.493] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:19:17.493] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:167:0) after 1m0s
[07:20:17.535] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:167:0)
[07:20:17.535] Timer tick, asking Buildbucket for the build status
[07:20:17.637] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:20:17.637] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:168:0) after 1m0s
[07:21:17.701] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:168:0)
[07:21:17.701] Timer tick, asking Buildbucket for the build status
[07:21:17.779] Build 8862054148875388544: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[07:21:17.779] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:169:0) after 1m0s
[07:22:11.273] Received PubSub notification, asking Buildbucket for the build status
[07:22:11.353] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:22:17.820] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:169:0)
[07:22:17.820] Timer tick, asking Buildbucket for the build status
[07:22:17.938] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:22:17.938] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:171:0) after 1m0s
[07:23:18.162] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:171:0)
[07:23:18.162] Timer tick, asking Buildbucket for the build status
[07:23:18.438] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:23:18.438] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:172:0) after 1m0s
[07:24:18.710] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:172:0)
[07:24:18.710] Timer tick, asking Buildbucket for the build status
[07:24:18.940] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:24:18.940] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:173:0) after 1m0s
[07:25:19.089] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:173:0)
[07:25:19.089] Timer tick, asking Buildbucket for the build status
[07:25:19.172] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:25:19.172] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:174:0) after 1m0s
[07:26:19.244] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:174:0)
[07:26:19.244] Timer tick, asking Buildbucket for the build status
[07:26:19.322] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:26:19.322] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:175:0) after 1m0s
[07:27:19.367] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:175:0)
[07:27:19.367] Timer tick, asking Buildbucket for the build status
[07:27:19.502] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:27:19.502] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:176:0) after 1m0s
[07:28:19.553] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:176:0)
[07:28:19.553] Timer tick, asking Buildbucket for the build status
[07:28:19.691] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:28:19.691] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:177:0) after 1m0s
[07:29:19.777] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:177:0)
[07:29:19.777] Timer tick, asking Buildbucket for the build status
[07:29:19.940] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:29:19.940] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:178:0) after 1m0s
[07:30:19.864] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:178:0)
[07:30:19.864] Timer tick, asking Buildbucket for the build status
[07:30:19.938] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:30:19.938] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:179:0) after 1m0s
[07:31:19.975] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:179:0)
[07:31:19.975] Timer tick, asking Buildbucket for the build status
[07:31:20.133] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:31:20.133] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:180:0) after 1m0s
[07:32:20.161] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:180:0)
[07:32:20.161] Timer tick, asking Buildbucket for the build status
[07:32:20.286] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:32:20.286] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:181:0) after 1m0s
[07:33:20.210] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:181:0)
[07:33:20.210] Timer tick, asking Buildbucket for the build status
[07:33:20.312] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:33:20.312] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:182:0) after 1m0s
[07:34:21.199] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:182:0)
[07:34:21.199] Timer tick, asking Buildbucket for the build status
[07:34:21.573] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:34:21.573] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:183:0) after 1m0s
[07:35:21.644] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:183:0)
[07:35:21.644] Timer tick, asking Buildbucket for the build status
[07:35:21.773] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:35:21.773] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:184:0) after 1m0s
[07:36:22.503] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:184:0)
[07:36:22.503] Timer tick, asking Buildbucket for the build status
[07:36:22.692] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:36:22.695] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:185:0) after 1m0s
[07:37:22.806] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:185:0)
[07:37:22.806] Timer tick, asking Buildbucket for the build status
[07:37:22.882] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:37:22.882] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:186:0) after 1m0s
[07:38:22.964] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:186:0)
[07:38:22.964] Timer tick, asking Buildbucket for the build status
[07:38:23.121] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:38:23.121] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:187:0) after 1m0s
[07:39:23.181] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:187:0)
[07:39:23.181] Timer tick, asking Buildbucket for the build status
[07:39:23.258] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:39:23.258] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:188:0) after 1m0s
[07:40:23.884] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:188:0)
[07:40:23.884] Timer tick, asking Buildbucket for the build status
[07:40:24.840] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:40:24.840] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:189:0) after 1m0s
[07:41:25.158] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:189:0)
[07:41:25.158] Timer tick, asking Buildbucket for the build status
[07:41:26.004] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:41:26.004] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:190:0) after 1m0s
[07:42:26.092] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:190:0)
[07:42:26.092] Timer tick, asking Buildbucket for the build status
[07:42:26.220] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:42:26.220] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:191:0) after 1m0s
[07:43:26.313] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:191:0)
[07:43:26.313] Timer tick, asking Buildbucket for the build status
[07:43:26.491] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:43:26.491] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:192:0) after 1m0s
[07:44:26.602] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:192:0)
[07:44:26.602] Timer tick, asking Buildbucket for the build status
[07:44:26.753] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:44:26.753] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:193:0) after 1m0s
[07:45:26.762] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:193:0)
[07:45:26.762] Timer tick, asking Buildbucket for the build status
[07:45:26.855] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:45:26.855] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:194:0) after 1m0s
[07:46:27.038] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:194:0)
[07:46:27.038] Timer tick, asking Buildbucket for the build status
[07:46:27.170] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:46:27.170] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:195:0) after 1m0s
[07:47:27.166] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:195:0)
[07:47:27.166] Timer tick, asking Buildbucket for the build status
[07:47:27.234] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:47:27.235] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:196:0) after 1m0s
[07:48:27.402] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:196:0)
[07:48:27.402] Timer tick, asking Buildbucket for the build status
[07:48:27.599] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:48:27.599] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:197:0) after 1m0s
[07:49:27.669] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:197:0)
[07:49:27.669] Timer tick, asking Buildbucket for the build status
[07:49:27.731] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:49:27.731] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:198:0) after 1m0s
[07:50:27.796] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:198:0)
[07:50:27.796] Timer tick, asking Buildbucket for the build status
[07:50:29.011] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:50:29.011] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:199:0) after 1m0s
[07:51:29.054] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:199:0)
[07:51:29.054] Timer tick, asking Buildbucket for the build status
[07:51:29.275] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:51:29.275] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:200:0) after 1m0s
[07:52:29.306] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:200:0)
[07:52:29.306] Timer tick, asking Buildbucket for the build status
[07:52:29.413] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:52:29.413] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:201:0) after 1m0s
[07:53:29.439] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:201:0)
[07:53:29.439] Timer tick, asking Buildbucket for the build status
[07:53:29.563] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:53:29.563] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:202:0) after 1m0s
[07:54:29.576] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:202:0)
[07:54:29.576] Timer tick, asking Buildbucket for the build status
[07:54:29.685] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:54:29.685] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:203:0) after 1m0s
[07:55:29.710] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:203:0)
[07:55:29.710] Timer tick, asking Buildbucket for the build status
[07:55:29.926] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:55:29.926] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:204:0) after 1m0s
[07:56:29.954] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:204:0)
[07:56:29.954] Timer tick, asking Buildbucket for the build status
[07:56:30.012] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:56:30.012] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:205:0) after 1m0s
[07:57:30.065] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:205:0)
[07:57:30.065] Timer tick, asking Buildbucket for the build status
[07:57:30.283] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:57:30.283] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:206:0) after 1m0s
[07:58:30.504] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:206:0)
[07:58:30.504] Timer tick, asking Buildbucket for the build status
[07:58:30.616] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:58:30.616] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:207:0) after 1m0s
[07:59:31.355] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:207:0)
[07:59:31.355] Timer tick, asking Buildbucket for the build status
[07:59:31.437] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:59:31.437] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:208:0) after 1m0s
[08:00:31.747] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:208:0)
[08:00:31.747] Timer tick, asking Buildbucket for the build status
[08:00:31.960] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:00:31.960] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:209:0) after 1m0s
[08:01:31.994] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:209:0)
[08:01:31.994] Timer tick, asking Buildbucket for the build status
[08:01:32.227] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:01:32.227] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:210:0) after 1m0s
[08:02:32.418] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:210:0)
[08:02:32.418] Timer tick, asking Buildbucket for the build status
[08:02:32.494] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:02:32.494] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:211:0) after 1m0s
[08:03:32.569] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:211:0)
[08:03:32.569] Timer tick, asking Buildbucket for the build status
[08:03:33.128] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:03:33.128] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:212:0) after 1m0s
[08:04:33.154] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:212:0)
[08:04:33.154] Timer tick, asking Buildbucket for the build status
[08:04:33.643] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:04:33.643] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:213:0) after 1m0s
[08:05:33.679] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:213:0)
[08:05:33.679] Timer tick, asking Buildbucket for the build status
[08:05:33.882] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:05:33.882] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:214:0) after 1m0s
[08:06:33.890] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:214:0)
[08:06:33.890] Timer tick, asking Buildbucket for the build status
[08:06:34.494] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:06:34.494] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:215:0) after 1m0s
[08:07:34.538] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:215:0)
[08:07:34.538] Timer tick, asking Buildbucket for the build status
[08:07:35.038] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:07:35.038] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:216:0) after 1m0s
[08:08:35.065] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:216:0)
[08:08:35.065] Timer tick, asking Buildbucket for the build status
[08:08:35.171] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:08:35.171] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:217:0) after 1m0s
[08:09:35.278] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:217:0)
[08:09:35.278] Timer tick, asking Buildbucket for the build status
[08:09:35.410] Build 8862054148875388544: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:09:35.411] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9027484210937504224:218:0) after 1m0s
[08:10:22.688] Received PubSub notification, asking Buildbucket for the build status
[08:10:22.765] Build 8862054148875388544: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[08:10:22.765] Buildbucket build:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "completed_ts": "1606896621578490",
    "created_by": "project:chromium",
    "created_ts": "1606883589824402",
    "id": "8862054148875388544",
    "parameters_json": "{\"builder_name\": \"win-upload-perfetto\", \"properties\": {}}",
    "project": "chromium",
    "result": "SUCCESS",
    "result_details_json": "{\"properties\": {\"$build/goma\": {\"enable_ats\": true, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$recipe_engine/milo/blamelist_pins\": [{\"host\": \"chromium.googlesource.com\", \"id\": \"57c04cd66e488a9420f338f8a4fdfe765ea4e7b1\", \"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\": \"luci-chromium-ci-win10-8-1-7m4b\", \"builder_group\": \"chromium.fyi\", \"buildername\": \"win-upload-perfetto\", \"buildnumber\": 1807, \"got_angle_revision\": \"0c47015b57a03230e0cab10532c3deed80604512\", \"got_dawn_revision\": \"6f5151f6572bf22c88d0b3152bebeaa460ac4723\", \"got_nacl_revision\": \"3ac0b060c794b64531b47dfded8ff8d951a5c648\", \"got_revision\": \"57c04cd66e488a9420f338f8a4fdfe765ea4e7b1\", \"got_revision_cp\": \"refs/heads/master@{#832712}\", \"got_swarming_client_revision\": \"1a072711d4388c62e02480fabc26c68c24494be9\", \"got_swiftshader_revision\": \"bfb211914759cc5deffbe9419cd1c2cae0573488\", \"got_v8_revision\": \"d4fd978f49d91844ea41f85afd8f3d917ef13e95\", \"got_v8_revision_cp\": \"refs/heads/8.9.74@{#1}\", \"got_webrtc_revision\": \"69662a99d30da64cbe064f5cc646bb75d77c0b71\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32735}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"swarm_hashes_refs/heads/master(at){#832712}_without_patch\": {\"upload_trace_processor\": \"84ce000f9f9cb927d56232c8784bda09d1960b4f\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_1bdf55b197d439c94705ddfba40ad846e2fdb8dd164b64a485766434889345a8_v2\", \"builder_1e6a29180cab26dd3348fa54abb67ed061f7a719cdb336cb75143b23c3452e80_v2\", \"builder_44d97c3a86930e13a38e1eaddb8e17f6891cb7883a214371e74f9ddef6b034c5_v2\", \"builder_48ce158d992f85c54a400240cc3d77408bb96a2369de806c235fde7d7ef64068_v2\", \"builder_572c7d4336ecb7e9d9870c0b7d73eb5c4ec9b5267736155cf1f0727554d722db_v2\", \"builder_6b755bbaffc280fb83e7e303317e4888b2acb597c551cb7db892c262f1cf5030_v2\", \"builder_7e7f4ebc5094421a46baff10228f22baf4d4d757ab94366d4bf23e3f4dc4e562_v2\", \"builder_9fe9814ce14bb8ceec490c2f73b354cfd72877294131c83e8f28b19a7d4650fc_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-win10-8-1-7m4b\"], \"image\": [\"chrome-win10-1703-20092300-22ba5320847\"], \"integrity\": [\"high\"], \"locale\": [\"en_US.cp1252\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.13\"], \"server_version\": [\"5640-d0eb544\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1606893730449415",
    "status": "COMPLETED",
    "status_changed_ts": "1606896622037589",
    "tags": [
      "build_address:luci.chromium.ci/win-upload-perfetto/1807",
      "builder:win-upload-perfetto",
      "scheduler_invocation_id:9027484210937504224",
      "scheduler_job_id:chromium/win-upload-perfetto",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8862054148875388544/+/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:503a8b5228603410",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1606896622101447",
    "url": "https://ci.chromium.org/b/8862054148875388544",
    "utcnow_ts": "1606896622752901"
  }
}
[08:10:22.765] Invocation finished in 3h37m14.291404594s with status SUCCEEDED