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

• cron:v1:4796 (5 years ago)

[10:35:13.277] New invocation is queued and will start shortly
[10:35:14.647] Starting the invocation (attempt 1)
[10:35:14.684] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[10:35:14.684] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[10:35:14.684] Buildbucket request:
{
  "bucket": "luci.chromium.ci",
  "client_operation_id": "9028910982310490176",
  "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:9028910982310490176",
    "scheduler_job_id:chromium/win-upload-perfetto",
    "user_agent:luci-scheduler"
  ]
}
[10:35:15.395] Buildbucket response:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "created_by": "project:chromium",
    "created_ts": "1605522914772673",
    "id": "8863480920078229808",
    "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": "1605522915192465",
    "tags": [
      "build_address:luci.chromium.ci/win-upload-perfetto/1754",
      "builder:win-upload-perfetto",
      "scheduler_invocation_id:9028910982310490176",
      "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/8863480920078229808/+/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": "1605522915192789",
    "url": "https://ci.chromium.org/b/8863480920078229808",
    "utcnow_ts": "1605522915379180"
  }
}
[10:35:15.395] Task URL: https://ci.chromium.org/b/8863480920078229808
[10:35:15.395] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:2:0) after 1m0s
[10:36:15.466] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:2:0)
[10:36:15.466] Timer tick, asking Buildbucket for the build status
[10:36:15.758] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:36:15.758] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:3:0) after 1m0s
[10:37:15.839] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:3:0)
[10:37:15.839] Timer tick, asking Buildbucket for the build status
[10:37:15.917] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:37:15.917] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:4:0) after 1m0s
[10:38:16.577] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:4:0)
[10:38:16.577] Timer tick, asking Buildbucket for the build status
[10:38:16.643] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:38:16.643] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:5:0) after 1m0s
[10:39:16.712] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:5:0)
[10:39:16.712] Timer tick, asking Buildbucket for the build status
[10:39:16.785] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:39:16.785] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:6:0) after 1m0s
[10:40:16.868] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:6:0)
[10:40:16.868] Timer tick, asking Buildbucket for the build status
[10:40:16.972] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:40:16.972] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:7:0) after 1m0s
[10:41:17.313] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:7:0)
[10:41:17.313] Timer tick, asking Buildbucket for the build status
[10:41:17.379] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:41:17.379] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:8:0) after 1m0s
[10:42:18.158] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:8:0)
[10:42:18.158] Timer tick, asking Buildbucket for the build status
[10:42:18.241] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:42:18.241] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:9:0) after 1m0s
[10:43:18.622] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:9:0)
[10:43:18.622] Timer tick, asking Buildbucket for the build status
[10:43:18.697] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:43:18.697] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:10:0) after 1m0s
[10:44:18.774] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:10:0)
[10:44:18.774] Timer tick, asking Buildbucket for the build status
[10:44:18.854] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:44:18.854] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:11:0) after 1m0s
[10:45:18.888] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:11:0)
[10:45:18.888] Timer tick, asking Buildbucket for the build status
[10:45:19.018] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:45:19.018] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:12:0) after 1m0s
[10:46:19.089] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:12:0)
[10:46:19.089] Timer tick, asking Buildbucket for the build status
[10:46:19.481] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:46:19.481] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:13:0) after 1m0s
[10:47:19.582] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:13:0)
[10:47:19.582] Timer tick, asking Buildbucket for the build status
[10:47:19.665] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:47:19.665] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:14:0) after 1m0s
[10:48:19.741] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:14:0)
[10:48:19.741] Timer tick, asking Buildbucket for the build status
[10:48:19.912] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:48:19.912] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:15:0) after 1m0s
[10:49:19.987] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:15:0)
[10:49:19.987] Timer tick, asking Buildbucket for the build status
[10:49:20.086] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:49:20.086] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:16:0) after 1m0s
[10:50:20.234] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:16:0)
[10:50:20.234] Timer tick, asking Buildbucket for the build status
[10:50:20.330] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:50:20.331] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:17:0) after 1m0s
[10:51:20.603] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:17:0)
[10:51:20.603] Timer tick, asking Buildbucket for the build status
[10:51:20.812] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:51:20.812] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:18:0) after 1m0s
[10:52:21.023] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:18:0)
[10:52:21.023] Timer tick, asking Buildbucket for the build status
[10:52:21.095] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:52:21.095] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:19:0) after 1m0s
[10:53:21.285] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:19:0)
[10:53:21.285] Timer tick, asking Buildbucket for the build status
[10:53:21.367] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:53:21.367] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:20:0) after 1m0s
[10:54:21.450] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:20:0)
[10:54:21.450] Timer tick, asking Buildbucket for the build status
[10:54:21.564] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:54:21.564] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:21:0) after 1m0s
[10:55:21.643] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:21:0)
[10:55:21.643] Timer tick, asking Buildbucket for the build status
[10:55:21.738] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:55:21.738] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:22:0) after 1m0s
[10:56:21.796] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:22:0)
[10:56:21.796] Timer tick, asking Buildbucket for the build status
[10:56:21.862] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:56:21.862] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:23:0) after 1m0s
[10:57:21.955] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:23:0)
[10:57:21.955] Timer tick, asking Buildbucket for the build status
[10:57:22.027] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:57:22.027] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:24:0) after 1m0s
[10:58:22.125] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:24:0)
[10:58:22.125] Timer tick, asking Buildbucket for the build status
[10:58:22.197] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:58:22.197] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:25:0) after 1m0s
[10:59:22.258] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:25:0)
[10:59:22.258] Timer tick, asking Buildbucket for the build status
[10:59:22.337] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:59:22.337] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:26:0) after 1m0s
[11:00:22.362] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:26:0)
[11:00:22.362] Timer tick, asking Buildbucket for the build status
[11:00:22.687] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:00:22.687] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:27:0) after 1m0s
[11:01:22.728] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:27:0)
[11:01:22.728] Timer tick, asking Buildbucket for the build status
[11:01:22.814] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:01:22.814] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:28:0) after 1m0s
[11:02:22.902] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:28:0)
[11:02:22.902] Timer tick, asking Buildbucket for the build status
[11:02:22.983] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:02:22.983] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:29:0) after 1m0s
[11:03:23.002] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:29:0)
[11:03:23.002] Timer tick, asking Buildbucket for the build status
[11:03:23.066] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:03:23.066] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:30:0) after 1m0s
[11:04:23.131] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:30:0)
[11:04:23.131] Timer tick, asking Buildbucket for the build status
[11:04:23.222] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:04:23.222] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:31:0) after 1m0s
[11:05:23.254] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:31:0)
[11:05:23.254] Timer tick, asking Buildbucket for the build status
[11:05:23.348] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:05:23.348] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:32:0) after 1m0s
[11:06:23.423] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:32:0)
[11:06:23.423] Timer tick, asking Buildbucket for the build status
[11:06:23.502] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:06:23.502] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:33:0) after 1m0s
[11:07:23.578] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:33:0)
[11:07:23.578] Timer tick, asking Buildbucket for the build status
[11:07:23.820] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:07:23.820] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:34:0) after 1m0s
[11:08:23.891] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:34:0)
[11:08:23.891] Timer tick, asking Buildbucket for the build status
[11:08:23.982] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:08:23.982] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:35:0) after 1m0s
[11:09:24.048] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:35:0)
[11:09:24.048] Timer tick, asking Buildbucket for the build status
[11:09:24.125] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:09:24.125] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:36:0) after 1m0s
[11:10:24.256] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:36:0)
[11:10:24.256] Timer tick, asking Buildbucket for the build status
[11:10:24.371] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:10:24.371] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:37:0) after 1m0s
[11:11:24.501] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:37:0)
[11:11:24.501] Timer tick, asking Buildbucket for the build status
[11:11:24.573] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:11:24.573] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:38:0) after 1m0s
[11:12:24.689] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:38:0)
[11:12:24.689] Timer tick, asking Buildbucket for the build status
[11:12:24.766] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:12:24.766] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:39:0) after 1m0s
[11:13:24.775] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:39:0)
[11:13:24.775] Timer tick, asking Buildbucket for the build status
[11:13:24.856] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:13:24.856] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:40:0) after 1m0s
[11:14:24.931] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:40:0)
[11:14:24.931] Timer tick, asking Buildbucket for the build status
[11:14:25.016] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:14:25.016] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:41:0) after 1m0s
[11:15:25.037] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:41:0)
[11:15:25.037] Timer tick, asking Buildbucket for the build status
[11:15:25.138] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:15:25.138] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:42:0) after 1m0s
[11:16:25.115] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:42:0)
[11:16:25.115] Timer tick, asking Buildbucket for the build status
[11:16:25.199] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:16:25.199] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:43:0) after 1m0s
[11:17:25.282] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:43:0)
[11:17:25.282] Timer tick, asking Buildbucket for the build status
[11:17:25.362] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:17:25.362] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:44:0) after 1m0s
[11:18:25.547] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:44:0)
[11:18:25.547] Timer tick, asking Buildbucket for the build status
[11:18:25.616] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:18:25.616] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:45:0) after 1m0s
[11:19:25.670] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:45:0)
[11:19:25.670] Timer tick, asking Buildbucket for the build status
[11:19:25.754] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:19:25.754] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:46:0) after 1m0s
[11:20:25.874] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:46:0)
[11:20:25.874] Timer tick, asking Buildbucket for the build status
[11:20:25.981] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:20:25.981] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:47:0) after 1m0s
[11:21:26.069] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:47:0)
[11:21:26.069] Timer tick, asking Buildbucket for the build status
[11:21:26.148] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:21:26.148] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:48:0) after 1m0s
[11:22:26.550] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:48:0)
[11:22:26.550] Timer tick, asking Buildbucket for the build status
[11:22:26.718] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:22:26.718] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:49:0) after 1m0s
[11:23:26.893] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:49:0)
[11:23:26.893] Timer tick, asking Buildbucket for the build status
[11:23:26.973] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:23:26.973] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:50:0) after 1m0s
[11:24:27.102] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:50:0)
[11:24:27.102] Timer tick, asking Buildbucket for the build status
[11:24:27.186] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:24:27.186] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:51:0) after 1m0s
[11:25:27.224] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:51:0)
[11:25:27.224] Timer tick, asking Buildbucket for the build status
[11:25:27.324] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:25:27.324] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:52:0) after 1m0s
[11:26:27.518] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:52:0)
[11:26:27.518] Timer tick, asking Buildbucket for the build status
[11:26:27.622] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:26:27.622] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:53:0) after 1m0s
[11:27:27.786] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:53:0)
[11:27:27.786] Timer tick, asking Buildbucket for the build status
[11:27:27.880] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:27:27.880] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:54:0) after 1m0s
[11:28:27.982] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:54:0)
[11:28:27.982] Timer tick, asking Buildbucket for the build status
[11:28:28.113] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:28:28.113] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:55:0) after 1m0s
[11:29:28.316] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:55:0)
[11:29:28.316] Timer tick, asking Buildbucket for the build status
[11:29:28.414] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:29:28.414] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:56:0) after 1m0s
[11:30:28.457] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:56:0)
[11:30:28.457] Timer tick, asking Buildbucket for the build status
[11:30:28.820] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:30:28.820] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:57:0) after 1m0s
[11:31:28.872] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:57:0)
[11:31:28.872] Timer tick, asking Buildbucket for the build status
[11:31:28.954] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:31:28.954] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:58:0) after 1m0s
[11:32:28.986] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:58:0)
[11:32:28.986] Timer tick, asking Buildbucket for the build status
[11:32:29.071] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:32:29.071] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:59:0) after 1m0s
[11:33:29.120] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:59:0)
[11:33:29.120] Timer tick, asking Buildbucket for the build status
[11:33:29.188] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:33:29.188] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:60:0) after 1m0s
[11:34:29.250] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:60:0)
[11:34:29.250] Timer tick, asking Buildbucket for the build status
[11:34:29.338] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:34:29.338] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:61:0) after 1m0s
[11:35:29.405] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:61:0)
[11:35:29.405] Timer tick, asking Buildbucket for the build status
[11:35:29.529] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:35:29.529] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:62:0) after 1m0s
[11:36:29.546] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:62:0)
[11:36:29.546] Timer tick, asking Buildbucket for the build status
[11:36:29.664] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:36:29.664] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:63:0) after 1m0s
[11:37:29.699] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:63:0)
[11:37:29.699] Timer tick, asking Buildbucket for the build status
[11:37:29.782] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:37:29.782] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:64:0) after 1m0s
[11:38:29.869] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:64:0)
[11:38:29.869] Timer tick, asking Buildbucket for the build status
[11:38:30.023] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:38:30.023] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:65:0) after 1m0s
[11:39:30.046] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:65:0)
[11:39:30.046] Timer tick, asking Buildbucket for the build status
[11:39:30.135] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:39:30.135] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:66:0) after 1m0s
[11:40:30.216] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:66:0)
[11:40:30.216] Timer tick, asking Buildbucket for the build status
[11:40:30.518] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:40:30.518] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:67:0) after 1m0s
[11:41:30.544] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:67:0)
[11:41:30.544] Timer tick, asking Buildbucket for the build status
[11:41:30.623] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:41:30.623] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:68:0) after 1m0s
[11:42:30.677] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:68:0)
[11:42:30.677] Timer tick, asking Buildbucket for the build status
[11:42:30.762] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:42:30.762] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:69:0) after 1m0s
[11:43:30.786] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:69:0)
[11:43:30.786] Timer tick, asking Buildbucket for the build status
[11:43:30.903] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:43:30.903] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:70:0) after 1m0s
[11:44:30.955] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:70:0)
[11:44:30.955] Timer tick, asking Buildbucket for the build status
[11:44:31.023] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:44:31.023] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:71:0) after 1m0s
[11:45:31.051] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:71:0)
[11:45:31.051] Timer tick, asking Buildbucket for the build status
[11:45:31.156] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:45:31.156] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:72:0) after 1m0s
[11:46:31.231] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:72:0)
[11:46:31.231] Timer tick, asking Buildbucket for the build status
[11:46:31.518] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:46:31.519] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:73:0) after 1m0s
[11:47:31.558] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:73:0)
[11:47:31.558] Timer tick, asking Buildbucket for the build status
[11:47:31.655] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:47:31.655] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:74:0) after 1m0s
[11:48:31.725] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:74:0)
[11:48:31.725] Timer tick, asking Buildbucket for the build status
[11:48:31.791] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:48:31.791] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:75:0) after 1m0s
[11:49:31.815] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:75:0)
[11:49:31.815] Timer tick, asking Buildbucket for the build status
[11:49:31.888] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:49:31.888] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:76:0) after 1m0s
[11:50:31.899] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:76:0)
[11:50:31.899] Timer tick, asking Buildbucket for the build status
[11:50:32.165] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:50:32.165] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:77:0) after 1m0s
[11:51:32.224] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:77:0)
[11:51:32.224] Timer tick, asking Buildbucket for the build status
[11:51:32.501] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:51:32.501] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:78:0) after 1m0s
[11:52:32.549] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:78:0)
[11:52:32.549] Timer tick, asking Buildbucket for the build status
[11:52:32.633] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:52:32.633] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:79:0) after 1m0s
[11:53:32.702] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:79:0)
[11:53:32.702] Timer tick, asking Buildbucket for the build status
[11:53:32.776] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:53:32.776] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:80:0) after 1m0s
[11:54:32.799] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:80:0)
[11:54:32.799] Timer tick, asking Buildbucket for the build status
[11:54:32.916] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:54:32.916] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:81:0) after 1m0s
[11:55:32.980] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:81:0)
[11:55:32.980] Timer tick, asking Buildbucket for the build status
[11:55:33.142] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:55:33.143] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:82:0) after 1m0s
[11:56:33.168] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:82:0)
[11:56:33.168] Timer tick, asking Buildbucket for the build status
[11:56:33.243] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:56:33.243] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:83:0) after 1m0s
[11:57:33.293] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:83:0)
[11:57:33.293] Timer tick, asking Buildbucket for the build status
[11:57:33.425] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:57:33.425] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:84:0) after 1m0s
[11:58:33.480] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:84:0)
[11:58:33.480] Timer tick, asking Buildbucket for the build status
[11:58:33.735] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:58:33.735] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:85:0) after 1m0s
[11:59:33.803] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:85:0)
[11:59:33.803] Timer tick, asking Buildbucket for the build status
[11:59:34.004] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[11:59:34.004] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:86:0) after 1m0s
[12:00:34.152] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:86:0)
[12:00:34.152] Timer tick, asking Buildbucket for the build status
[12:00:34.477] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:00:34.477] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:87:0) after 1m0s
[12:01:34.553] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:87:0)
[12:01:34.553] Timer tick, asking Buildbucket for the build status
[12:01:35.039] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:01:35.039] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:88:0) after 1m0s
[12:02:35.172] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:88:0)
[12:02:35.172] Timer tick, asking Buildbucket for the build status
[12:02:35.927] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:02:35.927] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:89:0) after 1m0s
[12:03:35.971] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:89:0)
[12:03:35.971] Timer tick, asking Buildbucket for the build status
[12:03:36.043] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:03:36.043] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:90:0) after 1m0s
[12:04:36.121] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:90:0)
[12:04:36.121] Timer tick, asking Buildbucket for the build status
[12:04:36.239] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:04:36.240] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:91:0) after 1m0s
[12:05:36.270] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:91:0)
[12:05:36.270] Timer tick, asking Buildbucket for the build status
[12:05:36.366] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:05:36.366] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:92:0) after 1m0s
[12:06:36.436] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:92:0)
[12:06:36.436] Timer tick, asking Buildbucket for the build status
[12:06:36.501] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:06:36.501] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:93:0) after 1m0s
[12:07:36.596] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:93:0)
[12:07:36.596] Timer tick, asking Buildbucket for the build status
[12:07:36.871] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:07:36.871] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:94:0) after 1m0s
[12:08:36.921] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:94:0)
[12:08:36.921] Timer tick, asking Buildbucket for the build status
[12:08:37.017] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:08:37.017] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:95:0) after 1m0s
[12:09:37.378] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:95:0)
[12:09:37.378] Timer tick, asking Buildbucket for the build status
[12:09:37.474] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:09:37.474] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:96:0) after 1m0s
[12:10:37.531] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:96:0)
[12:10:37.531] Timer tick, asking Buildbucket for the build status
[12:10:37.644] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:10:37.644] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:97:0) after 1m0s
[12:11:37.706] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:97:0)
[12:11:37.706] Timer tick, asking Buildbucket for the build status
[12:11:37.787] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:11:37.787] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:98:0) after 1m0s
[12:12:37.923] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:98:0)
[12:12:37.923] Timer tick, asking Buildbucket for the build status
[12:12:38.212] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:12:38.212] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:99:0) after 1m0s
[12:13:38.268] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:99:0)
[12:13:38.268] Timer tick, asking Buildbucket for the build status
[12:13:38.346] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:13:38.346] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:100:0) after 1m0s
[12:14:38.360] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:100:0)
[12:14:38.360] Timer tick, asking Buildbucket for the build status
[12:14:38.642] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:14:38.642] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:101:0) after 1m0s
[12:15:38.886] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:101:0)
[12:15:38.886] Timer tick, asking Buildbucket for the build status
[12:15:38.985] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:15:38.985] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:102:0) after 1m0s
[12:16:39.168] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:102:0)
[12:16:39.168] Timer tick, asking Buildbucket for the build status
[12:16:39.452] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:16:39.452] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:103:0) after 1m0s
[12:17:39.570] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:103:0)
[12:17:39.570] Timer tick, asking Buildbucket for the build status
[12:17:39.720] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:17:39.720] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:104:0) after 1m0s
[12:18:39.886] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:104:0)
[12:18:39.886] Timer tick, asking Buildbucket for the build status
[12:18:39.955] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:18:39.955] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:105:0) after 1m0s
[12:19:40.069] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:105:0)
[12:19:40.069] Timer tick, asking Buildbucket for the build status
[12:19:40.155] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:19:40.155] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:106:0) after 1m0s
[12:20:40.219] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:106:0)
[12:20:40.219] Timer tick, asking Buildbucket for the build status
[12:20:40.345] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:20:40.345] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:107:0) after 1m0s
[12:21:40.429] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:107:0)
[12:21:40.430] Timer tick, asking Buildbucket for the build status
[12:21:40.626] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:21:40.626] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:108:0) after 1m0s
[12:22:40.727] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:108:0)
[12:22:40.727] Timer tick, asking Buildbucket for the build status
[12:22:40.993] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:22:40.993] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:109:0) after 1m0s
[12:23:41.000] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:109:0)
[12:23:41.000] Timer tick, asking Buildbucket for the build status
[12:23:41.089] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:23:41.089] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:110:0) after 1m0s
[12:24:41.241] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:110:0)
[12:24:41.241] Timer tick, asking Buildbucket for the build status
[12:24:41.337] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:24:41.337] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:111:0) after 1m0s
[12:25:41.463] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:111:0)
[12:25:41.463] Timer tick, asking Buildbucket for the build status
[12:25:41.562] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:25:41.562] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:112:0) after 1m0s
[12:26:41.706] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:112:0)
[12:26:41.706] Timer tick, asking Buildbucket for the build status
[12:26:41.778] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:26:41.778] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:113:0) after 1m0s
[12:27:41.820] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:113:0)
[12:27:41.820] Timer tick, asking Buildbucket for the build status
[12:27:42.018] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:27:42.018] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:114:0) after 1m0s
[12:28:42.106] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:114:0)
[12:28:42.106] Timer tick, asking Buildbucket for the build status
[12:28:42.319] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:28:42.319] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:115:0) after 1m0s
[12:29:42.383] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:115:0)
[12:29:42.383] Timer tick, asking Buildbucket for the build status
[12:29:42.598] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:29:42.598] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:116:0) after 1m0s
[12:30:42.649] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:116:0)
[12:30:42.649] Timer tick, asking Buildbucket for the build status
[12:30:42.777] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:30:42.777] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:117:0) after 1m0s
[12:31:42.837] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:117:0)
[12:31:42.837] Timer tick, asking Buildbucket for the build status
[12:31:42.916] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:31:42.916] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:118:0) after 1m0s
[12:32:43.054] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:118:0)
[12:32:43.054] Timer tick, asking Buildbucket for the build status
[12:32:43.181] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:32:43.181] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:119:0) after 1m0s
[12:33:43.208] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:119:0)
[12:33:43.208] Timer tick, asking Buildbucket for the build status
[12:33:43.316] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:33:43.316] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:120:0) after 1m0s
[12:34:43.444] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:120:0)
[12:34:43.444] Timer tick, asking Buildbucket for the build status
[12:34:43.529] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:34:43.529] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:121:0) after 1m0s
[12:35:43.639] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:121:0)
[12:35:43.639] Timer tick, asking Buildbucket for the build status
[12:35:43.929] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:35:43.929] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:122:0) after 1m0s
[12:36:44.117] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:122:0)
[12:36:44.117] Timer tick, asking Buildbucket for the build status
[12:36:44.180] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:36:44.180] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:123:0) after 1m0s
[12:37:44.223] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:123:0)
[12:37:44.223] Timer tick, asking Buildbucket for the build status
[12:37:44.321] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:37:44.321] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:124:0) after 1m0s
[12:38:44.349] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:124:0)
[12:38:44.349] Timer tick, asking Buildbucket for the build status
[12:38:44.531] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:38:44.531] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:125:0) after 1m0s
[12:39:44.516] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:125:0)
[12:39:44.516] Timer tick, asking Buildbucket for the build status
[12:39:44.593] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:39:44.593] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:126:0) after 1m0s
[12:40:44.660] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:126:0)
[12:40:44.660] Timer tick, asking Buildbucket for the build status
[12:40:44.781] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:40:44.781] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:127:0) after 1m0s
[12:41:44.814] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:127:0)
[12:41:44.814] Timer tick, asking Buildbucket for the build status
[12:41:44.896] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:41:44.896] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:128:0) after 1m0s
[12:42:44.921] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:128:0)
[12:42:44.921] Timer tick, asking Buildbucket for the build status
[12:42:44.990] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:42:44.990] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:129:0) after 1m0s
[12:43:45.052] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:129:0)
[12:43:45.052] Timer tick, asking Buildbucket for the build status
[12:43:45.123] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:43:45.123] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:130:0) after 1m0s
[12:44:45.156] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:130:0)
[12:44:45.157] Timer tick, asking Buildbucket for the build status
[12:44:45.293] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:44:45.293] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:131:0) after 1m0s
[12:45:45.329] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:131:0)
[12:45:45.329] Timer tick, asking Buildbucket for the build status
[12:45:45.610] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:45:45.610] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:132:0) after 1m0s
[12:46:45.664] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:132:0)
[12:46:45.664] Timer tick, asking Buildbucket for the build status
[12:46:45.744] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:46:45.744] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:133:0) after 1m0s
[12:47:45.755] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:133:0)
[12:47:45.755] Timer tick, asking Buildbucket for the build status
[12:47:45.839] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:47:45.839] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:134:0) after 1m0s
[12:48:45.972] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:134:0)
[12:48:45.972] Timer tick, asking Buildbucket for the build status
[12:48:46.117] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:48:46.117] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:135:0) after 1m0s
[12:49:46.143] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:135:0)
[12:49:46.143] Timer tick, asking Buildbucket for the build status
[12:49:46.213] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:49:46.213] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:136:0) after 1m0s
[12:50:46.221] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:136:0)
[12:50:46.221] Timer tick, asking Buildbucket for the build status
[12:50:46.324] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:50:46.324] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:137:0) after 1m0s
[12:51:46.427] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:137:0)
[12:51:46.427] Timer tick, asking Buildbucket for the build status
[12:51:46.511] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:51:46.511] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:138:0) after 1m0s
[12:52:46.608] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:138:0)
[12:52:46.608] Timer tick, asking Buildbucket for the build status
[12:52:46.749] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:52:46.749] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:139:0) after 1m0s
[12:53:46.789] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:139:0)
[12:53:46.789] Timer tick, asking Buildbucket for the build status
[12:53:47.010] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:53:47.010] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:140:0) after 1m0s
[12:54:47.073] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:140:0)
[12:54:47.073] Timer tick, asking Buildbucket for the build status
[12:54:47.165] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:54:47.165] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:141:0) after 1m0s
[12:55:47.256] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:141:0)
[12:55:47.256] Timer tick, asking Buildbucket for the build status
[12:55:47.365] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:55:47.365] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:142:0) after 1m0s
[12:56:47.389] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:142:0)
[12:56:47.389] Timer tick, asking Buildbucket for the build status
[12:56:47.472] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:56:47.473] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:143:0) after 1m0s
[12:57:47.547] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:143:0)
[12:57:47.547] Timer tick, asking Buildbucket for the build status
[12:57:47.655] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:57:47.655] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:144:0) after 1m0s
[12:58:47.674] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:144:0)
[12:58:47.674] Timer tick, asking Buildbucket for the build status
[12:58:47.746] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:58:47.746] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:145:0) after 1m0s
[12:59:47.835] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:145:0)
[12:59:47.835] Timer tick, asking Buildbucket for the build status
[12:59:47.919] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[12:59:47.919] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:146:0) after 1m0s
[13:00:47.979] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:146:0)
[13:00:47.979] Timer tick, asking Buildbucket for the build status
[13:00:48.684] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:00:48.684] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:147:0) after 1m0s
[13:01:48.787] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:147:0)
[13:01:48.787] Timer tick, asking Buildbucket for the build status
[13:01:48.879] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:01:48.879] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:148:0) after 1m0s
[13:02:48.897] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:148:0)
[13:02:48.897] Timer tick, asking Buildbucket for the build status
[13:02:49.018] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:02:49.018] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:149:0) after 1m0s
[13:03:49.059] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:149:0)
[13:03:49.059] Timer tick, asking Buildbucket for the build status
[13:03:49.200] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:03:49.200] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:150:0) after 1m0s
[13:04:49.231] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:150:0)
[13:04:49.231] Timer tick, asking Buildbucket for the build status
[13:04:49.310] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:04:49.310] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:151:0) after 1m0s
[13:05:50.194] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:151:0)
[13:05:50.195] Timer tick, asking Buildbucket for the build status
[13:05:50.323] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:05:50.323] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:152:0) after 1m0s
[13:06:50.448] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:152:0)
[13:06:50.448] Timer tick, asking Buildbucket for the build status
[13:06:50.539] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:06:50.539] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:153:0) after 1m0s
[13:07:50.905] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:153:0)
[13:07:50.905] Timer tick, asking Buildbucket for the build status
[13:07:50.978] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:07:50.978] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:154:0) after 1m0s
[13:08:51.078] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:154:0)
[13:08:51.078] Timer tick, asking Buildbucket for the build status
[13:08:51.190] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:08:51.190] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:155:0) after 1m0s
[13:09:51.281] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:155:0)
[13:09:51.281] Timer tick, asking Buildbucket for the build status
[13:09:51.381] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:09:51.381] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:156:0) after 1m0s
[13:10:51.452] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:156:0)
[13:10:51.452] Timer tick, asking Buildbucket for the build status
[13:10:51.677] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:10:51.677] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:157:0) after 1m0s
[13:11:51.876] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:157:0)
[13:11:51.876] Timer tick, asking Buildbucket for the build status
[13:11:51.956] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:11:51.956] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:158:0) after 1m0s
[13:12:52.038] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:158:0)
[13:12:52.038] Timer tick, asking Buildbucket for the build status
[13:12:52.148] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:12:52.148] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:159:0) after 1m0s
[13:13:52.158] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:159:0)
[13:13:52.158] Timer tick, asking Buildbucket for the build status
[13:13:52.335] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:13:52.335] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:160:0) after 1m0s
[13:14:52.410] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:160:0)
[13:14:52.410] Timer tick, asking Buildbucket for the build status
[13:14:52.478] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:14:52.478] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:161:0) after 1m0s
[13:15:52.568] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:161:0)
[13:15:52.568] Timer tick, asking Buildbucket for the build status
[13:15:52.663] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:15:52.663] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:162:0) after 1m0s
[13:16:52.739] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:162:0)
[13:16:52.739] Timer tick, asking Buildbucket for the build status
[13:16:52.849] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:16:52.849] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:163:0) after 1m0s
[13:17:52.931] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:163:0)
[13:17:52.931] Timer tick, asking Buildbucket for the build status
[13:17:52.999] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:17:52.999] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:164:0) after 1m0s
[13:18:53.126] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:164:0)
[13:18:53.126] Timer tick, asking Buildbucket for the build status
[13:18:53.336] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:18:53.336] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:165:0) after 1m0s
[13:19:53.367] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:165:0)
[13:19:53.367] Timer tick, asking Buildbucket for the build status
[13:19:53.432] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:19:53.432] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:166:0) after 1m0s
[13:20:53.499] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:166:0)
[13:20:53.499] Timer tick, asking Buildbucket for the build status
[13:20:53.632] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:20:53.632] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:167:0) after 1m0s
[13:21:53.657] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:167:0)
[13:21:53.657] Timer tick, asking Buildbucket for the build status
[13:21:53.725] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:21:53.725] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:168:0) after 1m0s
[13:22:53.822] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:168:0)
[13:22:53.822] Timer tick, asking Buildbucket for the build status
[13:22:54.076] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:22:54.076] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:169:0) after 1m0s
[13:23:54.153] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:169:0)
[13:23:54.153] Timer tick, asking Buildbucket for the build status
[13:23:54.237] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:23:54.238] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:170:0) after 1m0s
[13:24:54.301] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:170:0)
[13:24:54.301] Timer tick, asking Buildbucket for the build status
[13:24:54.432] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:24:54.432] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:171:0) after 1m0s
[13:25:54.555] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:171:0)
[13:25:54.555] Timer tick, asking Buildbucket for the build status
[13:25:54.685] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:25:54.685] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:172:0) after 1m0s
[13:26:54.702] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:172:0)
[13:26:54.702] Timer tick, asking Buildbucket for the build status
[13:26:54.771] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:26:54.771] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:173:0) after 1m0s
[13:27:54.844] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:173:0)
[13:27:54.844] Timer tick, asking Buildbucket for the build status
[13:27:54.952] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:27:54.952] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:174:0) after 1m0s
[13:28:54.952] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:174:0)
[13:28:54.952] Timer tick, asking Buildbucket for the build status
[13:28:55.051] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:28:55.051] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:175:0) after 1m0s
[13:29:55.189] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:175:0)
[13:29:55.189] Timer tick, asking Buildbucket for the build status
[13:29:55.505] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:29:55.505] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:176:0) after 1m0s
[13:30:55.547] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:176:0)
[13:30:55.547] Timer tick, asking Buildbucket for the build status
[13:30:55.664] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:30:55.664] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:177:0) after 1m0s
[13:31:55.788] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:177:0)
[13:31:55.788] Timer tick, asking Buildbucket for the build status
[13:31:55.898] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:31:55.899] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:178:0) after 1m0s
[13:32:55.944] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:178:0)
[13:32:55.944] Timer tick, asking Buildbucket for the build status
[13:32:56.164] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:32:56.164] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:179:0) after 1m0s
[13:33:56.215] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:179:0)
[13:33:56.215] Timer tick, asking Buildbucket for the build status
[13:33:56.301] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:33:56.301] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:180:0) after 1m0s
[13:34:56.344] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:180:0)
[13:34:56.344] Timer tick, asking Buildbucket for the build status
[13:34:56.435] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:34:56.435] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:181:0) after 1m0s
[13:35:56.428] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:181:0)
[13:35:56.428] Timer tick, asking Buildbucket for the build status
[13:35:56.530] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:35:56.530] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:182:0) after 1m0s
[13:36:56.760] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:182:0)
[13:36:56.760] Timer tick, asking Buildbucket for the build status
[13:36:56.854] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:36:56.854] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:183:0) after 1m0s
[13:37:56.962] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:183:0)
[13:37:56.962] Timer tick, asking Buildbucket for the build status
[13:37:57.056] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:37:57.056] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:184:0) after 1m0s
[13:38:58.720] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:184:0)
[13:38:58.720] Timer tick, asking Buildbucket for the build status
[13:38:58.819] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:38:58.819] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:185:0) after 1m0s
[13:39:59.021] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:185:0)
[13:39:59.021] Timer tick, asking Buildbucket for the build status
[13:39:59.136] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:39:59.136] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:186:0) after 1m0s
[13:40:59.216] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:186:0)
[13:40:59.216] Timer tick, asking Buildbucket for the build status
[13:40:59.321] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:40:59.326] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:187:0) after 1m0s
[13:41:59.332] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:187:0)
[13:41:59.332] Timer tick, asking Buildbucket for the build status
[13:41:59.397] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:41:59.397] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:188:0) after 1m0s
[13:42:59.549] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:188:0)
[13:42:59.549] Timer tick, asking Buildbucket for the build status
[13:42:59.957] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:42:59.957] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:189:0) after 1m0s
[13:44:00.150] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:189:0)
[13:44:00.150] Timer tick, asking Buildbucket for the build status
[13:44:00.286] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:44:00.286] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:190:0) after 1m0s
[13:45:00.486] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:190:0)
[13:45:00.486] Timer tick, asking Buildbucket for the build status
[13:45:01.367] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:45:01.367] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:191:0) after 1m0s
[13:46:02.451] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:191:0)
[13:46:02.451] Timer tick, asking Buildbucket for the build status
[13:46:02.596] Build 8863480920078229808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[13:46:02.596] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:192:0) after 1m0s
[13:46:14.624] Received PubSub notification, asking Buildbucket for the build status
[13:46:14.706] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:47:03.096] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:192:0)
[13:47:03.096] Timer tick, asking Buildbucket for the build status
[13:47:03.223] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:47:03.225] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:194:0) after 1m0s
[13:48:03.451] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:194:0)
[13:48:03.451] Timer tick, asking Buildbucket for the build status
[13:48:03.665] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:48:03.665] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:195:0) after 1m0s
[13:49:03.843] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:195:0)
[13:49:03.843] Timer tick, asking Buildbucket for the build status
[13:49:03.892] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:49:03.892] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:196:0) after 1m0s
[13:50:04.021] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:196:0)
[13:50:04.021] Timer tick, asking Buildbucket for the build status
[13:50:04.146] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:50:04.146] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:197:0) after 1m0s
[13:51:04.864] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:197:0)
[13:51:04.864] Timer tick, asking Buildbucket for the build status
[13:51:04.964] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:51:04.964] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:198:0) after 1m0s
[13:52:05.366] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:198:0)
[13:52:05.366] Timer tick, asking Buildbucket for the build status
[13:52:05.435] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:52:05.435] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:199:0) after 1m0s
[13:53:05.662] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:199:0)
[13:53:05.662] Timer tick, asking Buildbucket for the build status
[13:53:05.730] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:53:05.730] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:200:0) after 1m0s
[13:54:05.952] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:200:0)
[13:54:05.952] Timer tick, asking Buildbucket for the build status
[13:54:06.076] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:54:06.076] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:201:0) after 1m0s
[13:55:06.278] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:201:0)
[13:55:06.278] Timer tick, asking Buildbucket for the build status
[13:55:06.340] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:55:06.340] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:202:0) after 1m0s
[13:56:06.364] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:202:0)
[13:56:06.365] Timer tick, asking Buildbucket for the build status
[13:56:06.774] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:56:06.774] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:203:0) after 1m0s
[13:57:06.841] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:203:0)
[13:57:06.841] Timer tick, asking Buildbucket for the build status
[13:57:06.934] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:57:06.934] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:204:0) after 1m0s
[13:58:07.042] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:204:0)
[13:58:07.042] Timer tick, asking Buildbucket for the build status
[13:58:07.124] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:58:07.125] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:205:0) after 1m0s
[13:59:07.168] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:205:0)
[13:59:07.168] Timer tick, asking Buildbucket for the build status
[13:59:07.349] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[13:59:07.349] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:206:0) after 1m0s
[14:00:07.423] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:206:0)
[14:00:07.424] Timer tick, asking Buildbucket for the build status
[14:00:07.547] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:00:07.547] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:207:0) after 1m0s
[14:01:07.709] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:207:0)
[14:01:07.709] Timer tick, asking Buildbucket for the build status
[14:01:07.827] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:01:07.827] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:208:0) after 1m0s
[14:02:08.138] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:208:0)
[14:02:08.138] Timer tick, asking Buildbucket for the build status
[14:02:08.725] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:02:08.725] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:209:0) after 1m0s
[14:03:08.946] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:209:0)
[14:03:08.946] Timer tick, asking Buildbucket for the build status
[14:03:09.018] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:03:09.018] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:210:0) after 1m0s
[14:04:09.144] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:210:0)
[14:04:09.144] Timer tick, asking Buildbucket for the build status
[14:04:09.286] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:04:09.286] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:211:0) after 1m0s
[14:05:09.377] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:211:0)
[14:05:09.377] Timer tick, asking Buildbucket for the build status
[14:05:09.526] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:05:09.526] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:212:0) after 1m0s
[14:06:09.705] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:212:0)
[14:06:09.705] Timer tick, asking Buildbucket for the build status
[14:06:09.885] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:09.885] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:213:0) after 1m0s
[14:07:10.050] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:213:0)
[14:07:10.050] Timer tick, asking Buildbucket for the build status
[14:07:10.120] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:07:10.120] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:214:0) after 1m0s
[14:08:10.269] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:214:0)
[14:08:10.269] Timer tick, asking Buildbucket for the build status
[14:08:10.343] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:08:10.343] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:215:0) after 1m0s
[14:09:10.525] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:215:0)
[14:09:10.532] Timer tick, asking Buildbucket for the build status
[14:09:10.606] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:09:10.606] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:216:0) after 1m0s
[14:10:10.682] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:216:0)
[14:10:10.682] Timer tick, asking Buildbucket for the build status
[14:10:10.758] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:10.758] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:217:0) after 1m0s
[14:11:10.851] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:217:0)
[14:11:10.851] Timer tick, asking Buildbucket for the build status
[14:11:10.989] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:10.989] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:218:0) after 1m0s
[14:12:11.087] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:218:0)
[14:12:11.087] Timer tick, asking Buildbucket for the build status
[14:12:11.504] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:11.504] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:219:0) after 1m0s
[14:13:11.580] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:219:0)
[14:13:11.580] Timer tick, asking Buildbucket for the build status
[14:13:11.943] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:11.943] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:220:0) after 1m0s
[14:14:12.047] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:220:0)
[14:14:12.047] Timer tick, asking Buildbucket for the build status
[14:14:12.152] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:12.152] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:221:0) after 1m0s
[14:15:12.189] Handling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:221:0)
[14:15:12.189] Timer tick, asking Buildbucket for the build status
[14:15:12.586] Build 8863480920078229808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:12.586] Scheduling timer "check-buildbucket-build-status" (chromium/win-upload-perfetto:9028910982310490176:222:0) after 1m0s
[14:15:30.142] Received PubSub notification, asking Buildbucket for the build status
[14:15:30.203] Build 8863480920078229808: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[14:15:30.203] Buildbucket build:
{
  "build": {
    "bucket": "luci.chromium.ci",
    "canary_preference": "PROD",
    "completed_ts": "1605536129132323",
    "created_by": "project:chromium",
    "created_ts": "1605522914772673",
    "failure_reason": "BUILD_FAILURE",
    "id": "8863480920078229808",
    "parameters_json": "{\"builder_name\": \"win-upload-perfetto\", \"properties\": {}}",
    "project": "chromium",
    "result": "FAILURE",
    "result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**upload_trace_processor** failed.\"}, \"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\": \"0ad7c15ed5d3674e560a44969c872c880a1f9c0f\", \"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-mxby\", \"builder_group\": \"chromium.fyi\", \"buildername\": \"win-upload-perfetto\", \"buildnumber\": 1754, \"got_angle_revision\": \"f46e6201b40bdee3e0b79d5d97660fc302fd76f5\", \"got_dawn_revision\": \"575729e8dd25e0ac4631c9739a82118ea3545c6b\", \"got_nacl_revision\": \"f9e6f257d1a0934dbeed3c5c8f83b651dc4f55e1\", \"got_revision\": \"0ad7c15ed5d3674e560a44969c872c880a1f9c0f\", \"got_revision_cp\": \"refs/heads/master@{#827767}\", \"got_swarming_client_revision\": \"d46ea7635f2911208268170512cb611412488fd8\", \"got_swiftshader_revision\": \"e4c1a25cc6797a47043fc415c53b8edcd7b3e37e\", \"got_v8_revision\": \"2dbcdc105b963ee2501c82139eef7e0603977ff0\", \"got_v8_revision_cp\": \"refs/heads/8.8.278@{#1}\", \"got_webrtc_revision\": \"99df1af2aed6a8d10bc62dc348f63d6c084c1949\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#32609}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"swarm_hashes_refs/heads/master(at){#827767}_without_patch\": {\"upload_trace_processor\": \"518e0bd23e061c10e5bd482455d096b557cb9609\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"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-mxby\"], \"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\": [\"5632-2e614e1\"], \"ssd\": [\"0\"], \"windows_client_version\": [\"10\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}, \"ui\": {\"info\": \"1 Test Suite(s) failed.\\n\\n**upload_trace_processor** failed.\"}}",
    "service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1605534372205808",
    "status": "COMPLETED",
    "status_changed_ts": "1605534372810935",
    "tags": [
      "build_address:luci.chromium.ci/win-upload-perfetto/1754",
      "builder:win-upload-perfetto",
      "scheduler_invocation_id:9028910982310490176",
      "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/8863480920078229808/+/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:4fe9710864418e10",
      "user_agent:luci-scheduler"
    ],
    "updated_ts": "1605536129237051",
    "url": "https://ci.chromium.org/b/8863480920078229808",
    "utcnow_ts": "1605536130195312"
  }
}
[14:15:30.203] Invocation finished in 3h40m16.942538639s with status FAILED