buildbucket: <
  server: "cr-buildbucket.appspot.com"
  bucket: "luci.infra.cron"
  builder: "Build From Tarball"
>

• publish_tarball/0 (5 years ago by chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com)

{
  "version": "89.0.4332.2"
}

• parent_buildername:publish_tarball
• user_agent:recipe

[07:47:44.701] New invocation is queued and will start shortly
[07:47:44.701] Triggered by user:chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com
[07:47:45.765] Starting the invocation (attempt 1)
[07:47:45.799] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[07:47:45.799] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[07:47:45.799] Buildbucket request:
{
  "bucket": "luci.infra.cron",
  "client_operation_id": "9028377937205372240",
  "parameters_json": "{\"builder_name\":\"Build From Tarball\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"buildbucket\":{\"properties\":{\"version\":\"89.0.4332.2\"},\"tags\":[\"parent_buildername:publish_tarball\",\"user_agent:recipe\"]},\"id\":\"9d3931ff-244a-44a7-a230-828908b19e93\",\"title\":\"publish_tarball/0\"}]},\"version\":\"89.0.4332.2\"}}",
  "pubsub_callback": {
    "auth_token": "...",
    "topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  },
  "tags": [
    "builder:Build From Tarball",
    "scheduler_invocation_id:9028377937205372240",
    "scheduler_job_id:infra/Build From Tarball",
    "user_agent:luci-scheduler",
    "parent_buildername:publish_tarball",
    "user_agent:recipe"
  ]
}
[07:47:46.264] Buildbucket response:
{
  "build": {
    "bucket": "luci.infra.cron",
    "canary_preference": "PROD",
    "created_by": "project:infra",
    "created_ts": "1606031265947587",
    "id": "8862947875236234208",
    "parameters_json": "{\"builder_name\": \"Build From Tarball\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"buildbucket\": {\"properties\": {\"version\": \"89.0.4332.2\"}, \"tags\": [\"parent_buildername:publish_tarball\", \"user_agent:recipe\"]}, \"id\": \"9d3931ff-244a-44a7-a230-828908b19e93\", \"title\": \"publish_tarball/0\"}]}, \"version\": \"89.0.4332.2\"}}",
    "project": "infra",
    "result_details_json": "{\"properties\": {}}",
    "service_account": "chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com",
    "status": "SCHEDULED",
    "status_changed_ts": "1606031266138264",
    "tags": [
      "builder:Build From Tarball",
      "parent_buildername:publish_tarball",
      "scheduler_invocation_id:9028377937205372240",
      "scheduler_job_id:infra/Build From Tarball",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8862947875236234208/+/annotations",
      "swarming_tag:luci_project:infra",
      "swarming_tag:recipe_name:build_from_tarball",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/infra/infra",
      "swarming_task_id:",
      "user_agent:luci-scheduler",
      "user_agent:recipe"
    ],
    "updated_ts": "1606031266138424",
    "url": "https://ci.chromium.org/b/8862947875236234208",
    "utcnow_ts": "1606031266254524"
  }
}
[07:47:46.264] Task URL: https://ci.chromium.org/b/8862947875236234208
[07:47:46.264] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:2:0) after 1m0s
[07:48:29.455] Received PubSub notification, asking Buildbucket for the build status
[07:48:29.529] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:48:46.350] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:2:0)
[07:48:46.350] Timer tick, asking Buildbucket for the build status
[07:48:46.427] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:48:46.427] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:4:0) after 1m0s
[07:49:46.449] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:4:0)
[07:49:46.449] Timer tick, asking Buildbucket for the build status
[07:49:46.552] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:49:46.552] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:5:0) after 1m0s
[07:50:46.536] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:5:0)
[07:50:46.536] Timer tick, asking Buildbucket for the build status
[07:50:46.633] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:50:46.633] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:6:0) after 1m0s
[07:51:46.651] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:6:0)
[07:51:46.651] Timer tick, asking Buildbucket for the build status
[07:51:46.742] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:51:46.742] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:7:0) after 1m0s
[07:52:46.761] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:7:0)
[07:52:46.761] Timer tick, asking Buildbucket for the build status
[07:52:46.934] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:52:46.934] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:8:0) after 1m0s
[07:53:46.953] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:8:0)
[07:53:46.953] Timer tick, asking Buildbucket for the build status
[07:53:47.046] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:53:47.046] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:9:0) after 1m0s
[07:54:47.065] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:9:0)
[07:54:47.065] Timer tick, asking Buildbucket for the build status
[07:54:47.132] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:54:47.132] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:10:0) after 1m0s
[07:55:47.150] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:10:0)
[07:55:47.150] Timer tick, asking Buildbucket for the build status
[07:55:47.205] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:55:47.205] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:11:0) after 1m0s
[07:56:47.228] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:11:0)
[07:56:47.229] Timer tick, asking Buildbucket for the build status
[07:56:47.293] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:56:47.293] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:12:0) after 1m0s
[07:57:47.314] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:12:0)
[07:57:47.314] Timer tick, asking Buildbucket for the build status
[07:57:47.375] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:57:47.375] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:13:0) after 1m0s
[07:58:47.392] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:13:0)
[07:58:47.392] Timer tick, asking Buildbucket for the build status
[07:58:47.489] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:58:47.489] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:14:0) after 1m0s
[07:59:47.510] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:14:0)
[07:59:47.510] Timer tick, asking Buildbucket for the build status
[07:59:47.558] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[07:59:47.558] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:15:0) after 1m0s
[08:00:47.584] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:15:0)
[08:00:47.584] Timer tick, asking Buildbucket for the build status
[08:00:47.672] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:00:47.672] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:16:0) after 1m0s
[08:01:47.649] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:16:0)
[08:01:47.649] Timer tick, asking Buildbucket for the build status
[08:01:47.706] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:01:47.706] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:17:0) after 1m0s
[08:02:47.729] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:17:0)
[08:02:47.729] Timer tick, asking Buildbucket for the build status
[08:02:47.793] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:02:47.793] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:18:0) after 1m0s
[08:03:47.829] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:18:0)
[08:03:47.829] Timer tick, asking Buildbucket for the build status
[08:03:47.935] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:03:47.935] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:19:0) after 1m0s
[08:04:47.959] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:19:0)
[08:04:47.959] Timer tick, asking Buildbucket for the build status
[08:04:48.046] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:04:48.046] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:20:0) after 1m0s
[08:05:48.050] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:20:0)
[08:05:48.051] Timer tick, asking Buildbucket for the build status
[08:05:48.222] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:05:48.222] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:21:0) after 1m0s
[08:06:48.245] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:21:0)
[08:06:48.245] Timer tick, asking Buildbucket for the build status
[08:06:48.305] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:06:48.305] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:22:0) after 1m0s
[08:07:48.329] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:22:0)
[08:07:48.329] Timer tick, asking Buildbucket for the build status
[08:07:48.519] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:07:48.519] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:23:0) after 1m0s
[08:08:48.606] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:23:0)
[08:08:48.606] Timer tick, asking Buildbucket for the build status
[08:08:48.676] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:08:48.676] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:24:0) after 1m0s
[08:09:48.764] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:24:0)
[08:09:48.764] Timer tick, asking Buildbucket for the build status
[08:09:48.820] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:09:48.820] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:25:0) after 1m0s
[08:10:49.079] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:25:0)
[08:10:49.079] Timer tick, asking Buildbucket for the build status
[08:10:49.136] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:10:49.136] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:26:0) after 1m0s
[08:11:49.351] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:26:0)
[08:11:49.351] Timer tick, asking Buildbucket for the build status
[08:11:49.413] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:11:49.413] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:27:0) after 1m0s
[08:12:49.467] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:27:0)
[08:12:49.467] Timer tick, asking Buildbucket for the build status
[08:12:49.571] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:12:49.571] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:28:0) after 1m0s
[08:13:49.615] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:28:0)
[08:13:49.615] Timer tick, asking Buildbucket for the build status
[08:13:49.679] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:13:49.679] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:29:0) after 1m0s
[08:14:49.717] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:29:0)
[08:14:49.717] Timer tick, asking Buildbucket for the build status
[08:14:49.905] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:14:49.905] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:30:0) after 1m0s
[08:15:49.928] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:30:0)
[08:15:49.928] Timer tick, asking Buildbucket for the build status
[08:15:50.202] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:15:50.202] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:31:0) after 1m0s
[08:16:50.223] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:31:0)
[08:16:50.223] Timer tick, asking Buildbucket for the build status
[08:16:50.340] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:16:50.340] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:32:0) after 1m0s
[08:17:50.371] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:32:0)
[08:17:50.371] Timer tick, asking Buildbucket for the build status
[08:17:50.485] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:17:50.485] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:33:0) after 1m0s
[08:18:50.567] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:33:0)
[08:18:50.567] Timer tick, asking Buildbucket for the build status
[08:18:50.943] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:18:50.943] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:34:0) after 1m0s
[08:19:50.956] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:34:0)
[08:19:50.956] Timer tick, asking Buildbucket for the build status
[08:19:51.162] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:19:51.162] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:35:0) after 1m0s
[08:20:51.250] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:35:0)
[08:20:51.250] Timer tick, asking Buildbucket for the build status
[08:20:51.317] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:20:51.317] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:36:0) after 1m0s
[08:21:51.351] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:36:0)
[08:21:51.351] Timer tick, asking Buildbucket for the build status
[08:21:51.521] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:21:51.521] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:37:0) after 1m0s
[08:22:51.543] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:37:0)
[08:22:51.543] Timer tick, asking Buildbucket for the build status
[08:22:51.648] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:22:51.648] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:38:0) after 1m0s
[08:23:51.671] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:38:0)
[08:23:51.671] Timer tick, asking Buildbucket for the build status
[08:23:51.731] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:23:51.732] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:39:0) after 1m0s
[08:24:51.751] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:39:0)
[08:24:51.751] Timer tick, asking Buildbucket for the build status
[08:24:51.834] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:24:51.834] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:40:0) after 1m0s
[08:25:51.884] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:40:0)
[08:25:51.884] Timer tick, asking Buildbucket for the build status
[08:25:51.945] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:25:51.945] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:41:0) after 1m0s
[08:26:51.987] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:41:0)
[08:26:51.987] Timer tick, asking Buildbucket for the build status
[08:26:52.178] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:26:52.178] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:42:0) after 1m0s
[08:27:52.204] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:42:0)
[08:27:52.204] Timer tick, asking Buildbucket for the build status
[08:27:52.467] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:27:52.467] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:43:0) after 1m0s
[08:28:52.489] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:43:0)
[08:28:52.489] Timer tick, asking Buildbucket for the build status
[08:28:52.561] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:28:52.561] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:44:0) after 1m0s
[08:29:52.587] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:44:0)
[08:29:52.587] Timer tick, asking Buildbucket for the build status
[08:29:52.737] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:29:52.737] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:45:0) after 1m0s
[08:30:52.771] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:45:0)
[08:30:52.771] Timer tick, asking Buildbucket for the build status
[08:30:52.836] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:30:52.836] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:46:0) after 1m0s
[08:31:52.858] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:46:0)
[08:31:52.858] Timer tick, asking Buildbucket for the build status
[08:31:52.924] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:31:52.924] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:47:0) after 1m0s
[08:32:52.929] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:47:0)
[08:32:52.929] Timer tick, asking Buildbucket for the build status
[08:32:53.087] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:32:53.087] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:48:0) after 1m0s
[08:33:53.206] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:48:0)
[08:33:53.206] Timer tick, asking Buildbucket for the build status
[08:33:53.421] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:33:53.421] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:49:0) after 1m0s
[08:34:53.526] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:49:0)
[08:34:53.526] Timer tick, asking Buildbucket for the build status
[08:34:56.042] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:34:56.042] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:50:0) after 1m0s
[08:35:56.068] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:50:0)
[08:35:56.068] Timer tick, asking Buildbucket for the build status
[08:35:56.126] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:35:56.126] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:51:0) after 1m0s
[08:36:56.168] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:51:0)
[08:36:56.168] Timer tick, asking Buildbucket for the build status
[08:36:56.224] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:36:56.224] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:52:0) after 1m0s
[08:37:56.303] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:52:0)
[08:37:56.303] Timer tick, asking Buildbucket for the build status
[08:37:56.408] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:37:56.408] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:53:0) after 1m0s
[08:38:56.489] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:53:0)
[08:38:56.489] Timer tick, asking Buildbucket for the build status
[08:38:56.559] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:38:56.559] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:54:0) after 1m0s
[08:39:56.605] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:54:0)
[08:39:56.605] Timer tick, asking Buildbucket for the build status
[08:39:56.837] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:39:56.837] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:55:0) after 1m0s
[08:40:56.857] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:55:0)
[08:40:56.857] Timer tick, asking Buildbucket for the build status
[08:40:56.919] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:40:56.919] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:56:0) after 1m0s
[08:41:56.945] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:56:0)
[08:41:56.945] Timer tick, asking Buildbucket for the build status
[08:41:57.011] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:41:57.011] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:57:0) after 1m0s
[08:42:57.022] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:57:0)
[08:42:57.022] Timer tick, asking Buildbucket for the build status
[08:42:57.149] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:42:57.149] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:58:0) after 1m0s
[08:43:57.170] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:58:0)
[08:43:57.170] Timer tick, asking Buildbucket for the build status
[08:43:57.226] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:43:57.226] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:59:0) after 1m0s
[08:44:57.203] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:59:0)
[08:44:57.203] Timer tick, asking Buildbucket for the build status
[08:44:57.386] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:44:57.386] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:60:0) after 1m0s
[08:45:57.432] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:60:0)
[08:45:57.432] Timer tick, asking Buildbucket for the build status
[08:45:57.506] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:45:57.506] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:61:0) after 1m0s
[08:46:57.533] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:61:0)
[08:46:57.533] Timer tick, asking Buildbucket for the build status
[08:46:57.582] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:46:57.582] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:62:0) after 1m0s
[08:47:57.615] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:62:0)
[08:47:57.615] Timer tick, asking Buildbucket for the build status
[08:47:57.982] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:47:57.982] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:63:0) after 1m0s
[08:48:58.005] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:63:0)
[08:48:58.005] Timer tick, asking Buildbucket for the build status
[08:48:58.066] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:48:58.066] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:64:0) after 1m0s
[08:49:58.088] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:64:0)
[08:49:58.088] Timer tick, asking Buildbucket for the build status
[08:49:58.137] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:49:58.137] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:65:0) after 1m0s
[08:50:58.189] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:65:0)
[08:50:58.189] Timer tick, asking Buildbucket for the build status
[08:50:58.248] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:50:58.248] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:66:0) after 1m0s
[08:51:58.270] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:66:0)
[08:51:58.270] Timer tick, asking Buildbucket for the build status
[08:51:58.340] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:51:58.340] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:67:0) after 1m0s
[08:52:58.376] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:67:0)
[08:52:58.376] Timer tick, asking Buildbucket for the build status
[08:52:58.547] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:52:58.547] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:68:0) after 1m0s
[08:53:58.557] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:68:0)
[08:53:58.557] Timer tick, asking Buildbucket for the build status
[08:53:58.619] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:53:58.619] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:69:0) after 1m0s
[08:54:58.645] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:69:0)
[08:54:58.645] Timer tick, asking Buildbucket for the build status
[08:54:58.804] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:54:58.804] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:70:0) after 1m0s
[08:55:58.808] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:70:0)
[08:55:58.808] Timer tick, asking Buildbucket for the build status
[08:55:58.866] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:55:58.866] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:71:0) after 1m0s
[08:56:58.891] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:71:0)
[08:56:58.891] Timer tick, asking Buildbucket for the build status
[08:56:58.945] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:56:58.945] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:72:0) after 1m0s
[08:57:59.003] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:72:0)
[08:57:59.003] Timer tick, asking Buildbucket for the build status
[08:57:59.229] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:57:59.229] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:73:0) after 1m0s
[08:58:59.259] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:73:0)
[08:58:59.259] Timer tick, asking Buildbucket for the build status
[08:58:59.312] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:58:59.312] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:74:0) after 1m0s
[08:59:59.335] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:74:0)
[08:59:59.335] Timer tick, asking Buildbucket for the build status
[08:59:59.406] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[08:59:59.406] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:75:0) after 1m0s
[09:00:59.426] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:75:0)
[09:00:59.426] Timer tick, asking Buildbucket for the build status
[09:00:59.548] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:00:59.548] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:76:0) after 1m0s
[09:01:59.567] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:76:0)
[09:01:59.567] Timer tick, asking Buildbucket for the build status
[09:01:59.651] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:01:59.651] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:77:0) after 1m0s
[09:02:59.727] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:77:0)
[09:02:59.727] Timer tick, asking Buildbucket for the build status
[09:02:59.980] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:02:59.980] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:78:0) after 1m0s
[09:04:00.015] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:78:0)
[09:04:00.015] Timer tick, asking Buildbucket for the build status
[09:04:00.302] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:04:00.302] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:79:0) after 1m0s
[09:05:00.456] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:79:0)
[09:05:00.457] Timer tick, asking Buildbucket for the build status
[09:05:00.527] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:05:00.527] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:80:0) after 1m0s
[09:06:00.530] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:80:0)
[09:06:00.530] Timer tick, asking Buildbucket for the build status
[09:06:00.633] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:06:00.633] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:81:0) after 1m0s
[09:07:00.674] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:81:0)
[09:07:00.674] Timer tick, asking Buildbucket for the build status
[09:07:00.754] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:07:00.754] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:82:0) after 1m0s
[09:08:00.759] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:82:0)
[09:08:00.759] Timer tick, asking Buildbucket for the build status
[09:08:02.299] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:08:02.299] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:83:0) after 1m0s
[09:09:02.341] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:83:0)
[09:09:02.341] Timer tick, asking Buildbucket for the build status
[09:09:02.398] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:09:02.398] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:84:0) after 1m0s
[09:10:02.497] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:84:0)
[09:10:02.497] Timer tick, asking Buildbucket for the build status
[09:10:03.862] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:10:03.862] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:85:0) after 1m0s
[09:11:03.884] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:85:0)
[09:11:03.884] Timer tick, asking Buildbucket for the build status
[09:11:03.943] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:11:03.943] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:86:0) after 1m0s
[09:12:03.973] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:86:0)
[09:12:03.973] Timer tick, asking Buildbucket for the build status
[09:12:04.063] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:12:04.063] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:87:0) after 1m0s
[09:13:04.128] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:87:0)
[09:13:04.128] Timer tick, asking Buildbucket for the build status
[09:13:04.236] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:13:04.236] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:88:0) after 1m0s
[09:14:04.220] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:88:0)
[09:14:04.220] Timer tick, asking Buildbucket for the build status
[09:14:04.282] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:14:04.282] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:89:0) after 1m0s
[09:15:04.381] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:89:0)
[09:15:04.381] Timer tick, asking Buildbucket for the build status
[09:15:04.537] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:15:04.537] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:90:0) after 1m0s
[09:16:04.601] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:90:0)
[09:16:04.601] Timer tick, asking Buildbucket for the build status
[09:16:04.666] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:16:04.666] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:91:0) after 1m0s
[09:17:04.688] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:91:0)
[09:17:04.688] Timer tick, asking Buildbucket for the build status
[09:17:04.747] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:17:04.747] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:92:0) after 1m0s
[09:18:04.745] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:92:0)
[09:18:04.745] Timer tick, asking Buildbucket for the build status
[09:18:04.856] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:18:04.856] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:93:0) after 1m0s
[09:19:04.882] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:93:0)
[09:19:04.882] Timer tick, asking Buildbucket for the build status
[09:19:04.947] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:19:04.947] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:94:0) after 1m0s
[09:20:04.985] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:94:0)
[09:20:04.985] Timer tick, asking Buildbucket for the build status
[09:20:05.130] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:20:05.130] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:95:0) after 1m0s
[09:21:05.349] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:95:0)
[09:21:05.349] Timer tick, asking Buildbucket for the build status
[09:21:05.413] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:21:05.413] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:96:0) after 1m0s
[09:22:05.564] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:96:0)
[09:22:05.564] Timer tick, asking Buildbucket for the build status
[09:22:05.633] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:22:05.633] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:97:0) after 1m0s
[09:23:05.667] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:97:0)
[09:23:05.667] Timer tick, asking Buildbucket for the build status
[09:23:05.757] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:23:05.757] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:98:0) after 1m0s
[09:24:05.779] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:98:0)
[09:24:05.779] Timer tick, asking Buildbucket for the build status
[09:24:05.886] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:24:05.886] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:99:0) after 1m0s
[09:25:05.925] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:99:0)
[09:25:05.925] Timer tick, asking Buildbucket for the build status
[09:25:05.984] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:25:05.984] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:100:0) after 1m0s
[09:26:06.024] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:100:0)
[09:26:06.024] Timer tick, asking Buildbucket for the build status
[09:26:06.214] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:26:06.214] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:101:0) after 1m0s
[09:27:06.251] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:101:0)
[09:27:06.251] Timer tick, asking Buildbucket for the build status
[09:27:06.307] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:27:06.307] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:102:0) after 1m0s
[09:28:06.365] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:102:0)
[09:28:06.365] Timer tick, asking Buildbucket for the build status
[09:28:06.473] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:28:06.473] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:103:0) after 1m0s
[09:29:06.498] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:103:0)
[09:29:06.498] Timer tick, asking Buildbucket for the build status
[09:29:06.570] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:29:06.570] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:104:0) after 1m0s
[09:30:06.766] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:104:0)
[09:30:06.767] Timer tick, asking Buildbucket for the build status
[09:30:06.856] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:30:06.856] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:105:0) after 1m0s
[09:31:08.171] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:105:0)
[09:31:08.171] Timer tick, asking Buildbucket for the build status
[09:31:08.234] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:31:08.234] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:106:0) after 1m0s
[09:32:08.348] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:106:0)
[09:32:08.348] Timer tick, asking Buildbucket for the build status
[09:32:08.492] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:32:08.493] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:107:0) after 1m0s
[09:33:08.569] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:107:0)
[09:33:08.569] Timer tick, asking Buildbucket for the build status
[09:33:08.672] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:33:08.672] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:108:0) after 1m0s
[09:34:08.701] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:108:0)
[09:34:08.701] Timer tick, asking Buildbucket for the build status
[09:34:08.762] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:34:08.762] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:109:0) after 1m0s
[09:35:08.810] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:109:0)
[09:35:08.810] Timer tick, asking Buildbucket for the build status
[09:35:08.884] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:35:08.884] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:110:0) after 1m0s
[09:36:08.987] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:110:0)
[09:36:08.987] Timer tick, asking Buildbucket for the build status
[09:36:09.466] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:36:09.466] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:111:0) after 1m0s
[09:37:12.332] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:111:0)
[09:37:12.332] Timer tick, asking Buildbucket for the build status
[09:37:12.395] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:37:12.395] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:112:0) after 1m0s
[09:38:12.451] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:112:0)
[09:38:12.451] Timer tick, asking Buildbucket for the build status
[09:38:12.684] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:38:12.684] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:113:0) after 1m0s
[09:39:12.820] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:113:0)
[09:39:12.820] Timer tick, asking Buildbucket for the build status
[09:39:12.885] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:39:12.885] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:114:0) after 1m0s
[09:40:12.932] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:114:0)
[09:40:12.932] Timer tick, asking Buildbucket for the build status
[09:40:13.000] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:40:13.000] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:115:0) after 1m0s
[09:41:12.989] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:115:0)
[09:41:12.989] Timer tick, asking Buildbucket for the build status
[09:41:13.059] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:41:13.059] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:116:0) after 1m0s
[09:42:13.081] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:116:0)
[09:42:13.081] Timer tick, asking Buildbucket for the build status
[09:42:19.490] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:42:19.490] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:117:0) after 1m0s
[09:43:19.545] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:117:0)
[09:43:19.545] Timer tick, asking Buildbucket for the build status
[09:43:19.663] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:43:19.663] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:118:0) after 1m0s
[09:44:19.647] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:118:0)
[09:44:19.647] Timer tick, asking Buildbucket for the build status
[09:44:19.704] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:44:19.704] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:119:0) after 1m0s
[09:45:19.764] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:119:0)
[09:45:19.764] Timer tick, asking Buildbucket for the build status
[09:45:19.860] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:45:19.860] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:120:0) after 1m0s
[09:46:19.893] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:120:0)
[09:46:19.893] Timer tick, asking Buildbucket for the build status
[09:46:20.019] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:46:20.019] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:121:0) after 1m0s
[09:47:20.043] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:121:0)
[09:47:20.043] Timer tick, asking Buildbucket for the build status
[09:47:20.267] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:47:20.267] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:122:0) after 1m0s
[09:48:20.492] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:122:0)
[09:48:20.492] Timer tick, asking Buildbucket for the build status
[09:48:20.628] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:48:20.628] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:123:0) after 1m0s
[09:49:20.647] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:123:0)
[09:49:20.647] Timer tick, asking Buildbucket for the build status
[09:49:20.716] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:49:20.716] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:124:0) after 1m0s
[09:50:20.793] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:124:0)
[09:50:20.793] Timer tick, asking Buildbucket for the build status
[09:50:20.986] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:50:20.986] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:125:0) after 1m0s
[09:51:21.322] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:125:0)
[09:51:21.322] Timer tick, asking Buildbucket for the build status
[09:51:21.606] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:51:21.606] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:126:0) after 1m0s
[09:52:21.728] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:126:0)
[09:52:21.728] Timer tick, asking Buildbucket for the build status
[09:52:22.946] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:52:22.946] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:127:0) after 1m0s
[09:53:23.057] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:127:0)
[09:53:23.057] Timer tick, asking Buildbucket for the build status
[09:53:23.180] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:53:23.180] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:128:0) after 1m0s
[09:54:23.351] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:128:0)
[09:54:23.351] Timer tick, asking Buildbucket for the build status
[09:54:23.437] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:54:23.437] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:129:0) after 1m0s
[09:55:23.682] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:129:0)
[09:55:23.682] Timer tick, asking Buildbucket for the build status
[09:55:23.759] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:55:23.759] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:130:0) after 1m0s
[09:56:24.015] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:130:0)
[09:56:24.015] Timer tick, asking Buildbucket for the build status
[09:56:24.088] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:56:24.088] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:131:0) after 1m0s
[09:57:24.186] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:131:0)
[09:57:24.186] Timer tick, asking Buildbucket for the build status
[09:57:26.059] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:57:26.059] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:132:0) after 1m0s
[09:58:26.344] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:132:0)
[09:58:26.344] Timer tick, asking Buildbucket for the build status
[09:58:26.462] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:58:26.462] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:133:0) after 1m0s
[09:59:26.568] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:133:0)
[09:59:26.568] Timer tick, asking Buildbucket for the build status
[09:59:26.622] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:59:26.622] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:134:0) after 1m0s
[10:00:26.705] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:134:0)
[10:00:26.705] Timer tick, asking Buildbucket for the build status
[10:00:27.384] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:00:27.384] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:135:0) after 1m0s
[10:01:27.405] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:135:0)
[10:01:27.405] Timer tick, asking Buildbucket for the build status
[10:01:27.547] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:01:27.547] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:136:0) after 1m0s
[10:02:27.576] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:136:0)
[10:02:27.576] Timer tick, asking Buildbucket for the build status
[10:02:27.746] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:02:27.746] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:137:0) after 1m0s
[10:03:27.768] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:137:0)
[10:03:27.768] Timer tick, asking Buildbucket for the build status
[10:03:27.900] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:03:27.900] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:138:0) after 1m0s
[10:04:27.933] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:138:0)
[10:04:27.933] Timer tick, asking Buildbucket for the build status
[10:04:27.997] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:04:27.997] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:139:0) after 1m0s
[10:05:28.024] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:139:0)
[10:05:28.024] Timer tick, asking Buildbucket for the build status
[10:05:28.154] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:05:28.154] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:140:0) after 1m0s
[10:06:28.190] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:140:0)
[10:06:28.190] Timer tick, asking Buildbucket for the build status
[10:06:28.253] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:06:28.253] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:141:0) after 1m0s
[10:07:28.299] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:141:0)
[10:07:28.299] Timer tick, asking Buildbucket for the build status
[10:07:28.387] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:07:28.387] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:142:0) after 1m0s
[10:08:28.414] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:142:0)
[10:08:28.414] Timer tick, asking Buildbucket for the build status
[10:08:28.598] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:08:28.598] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:143:0) after 1m0s
[10:09:28.628] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:143:0)
[10:09:28.628] Timer tick, asking Buildbucket for the build status
[10:09:28.725] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:09:28.725] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:144:0) after 1m0s
[10:10:28.749] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:144:0)
[10:10:28.750] Timer tick, asking Buildbucket for the build status
[10:10:28.813] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:10:28.813] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:145:0) after 1m0s
[10:11:28.840] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:145:0)
[10:11:28.840] Timer tick, asking Buildbucket for the build status
[10:11:28.905] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:11:28.905] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:146:0) after 1m0s
[10:12:28.928] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:146:0)
[10:12:28.928] Timer tick, asking Buildbucket for the build status
[10:12:28.998] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:12:28.998] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:147:0) after 1m0s
[10:13:29.023] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:147:0)
[10:13:29.023] Timer tick, asking Buildbucket for the build status
[10:13:29.189] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:13:29.189] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:148:0) after 1m0s
[10:14:29.243] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:148:0)
[10:14:29.243] Timer tick, asking Buildbucket for the build status
[10:14:29.307] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:14:29.307] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:149:0) after 1m0s
[10:15:29.355] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:149:0)
[10:15:29.355] Timer tick, asking Buildbucket for the build status
[10:15:29.446] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:15:29.446] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:150:0) after 1m0s
[10:16:29.497] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:150:0)
[10:16:29.497] Timer tick, asking Buildbucket for the build status
[10:16:29.577] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:16:29.577] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:151:0) after 1m0s
[10:17:29.579] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:151:0)
[10:17:29.579] Timer tick, asking Buildbucket for the build status
[10:17:29.871] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:17:29.871] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:152:0) after 1m0s
[10:18:30.002] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:152:0)
[10:18:30.002] Timer tick, asking Buildbucket for the build status
[10:18:30.287] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:18:30.287] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:153:0) after 1m0s
[10:19:30.330] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:153:0)
[10:19:30.330] Timer tick, asking Buildbucket for the build status
[10:19:30.396] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:19:30.396] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:154:0) after 1m0s
[10:20:30.433] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:154:0)
[10:20:30.433] Timer tick, asking Buildbucket for the build status
[10:20:30.527] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:20:30.527] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:155:0) after 1m0s
[10:21:30.735] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:155:0)
[10:21:30.735] Timer tick, asking Buildbucket for the build status
[10:21:30.793] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:21:30.793] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:156:0) after 1m0s
[10:22:30.786] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:156:0)
[10:22:30.787] Timer tick, asking Buildbucket for the build status
[10:22:30.895] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:22:30.895] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:157:0) after 1m0s
[10:23:30.919] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:157:0)
[10:23:30.919] Timer tick, asking Buildbucket for the build status
[10:23:31.034] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:23:31.034] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:158:0) after 1m0s
[10:24:31.079] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:158:0)
[10:24:31.079] Timer tick, asking Buildbucket for the build status
[10:24:31.144] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:24:31.144] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:159:0) after 1m0s
[10:25:31.171] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:159:0)
[10:25:31.171] Timer tick, asking Buildbucket for the build status
[10:25:31.228] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:25:31.228] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:160:0) after 1m0s
[10:26:31.286] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:160:0)
[10:26:31.286] Timer tick, asking Buildbucket for the build status
[10:26:31.369] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:26:31.369] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:161:0) after 1m0s
[10:27:31.412] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:161:0)
[10:27:31.412] Timer tick, asking Buildbucket for the build status
[10:27:31.478] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:27:31.478] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:162:0) after 1m0s
[10:28:31.521] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:162:0)
[10:28:31.521] Timer tick, asking Buildbucket for the build status
[10:28:31.619] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:28:31.619] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:163:0) after 1m0s
[10:29:31.695] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:163:0)
[10:29:31.695] Timer tick, asking Buildbucket for the build status
[10:29:31.759] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:29:31.759] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:164:0) after 1m0s
[10:30:31.860] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:164:0)
[10:30:31.860] Timer tick, asking Buildbucket for the build status
[10:30:33.335] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:30:33.335] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:165:0) after 1m0s
[10:31:33.489] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:165:0)
[10:31:33.489] Timer tick, asking Buildbucket for the build status
[10:31:33.556] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:31:33.556] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:166:0) after 1m0s
[10:32:33.638] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:166:0)
[10:32:33.638] Timer tick, asking Buildbucket for the build status
[10:32:33.792] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:32:33.792] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:167:0) after 1m0s
[10:33:33.819] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:167:0)
[10:33:33.819] Timer tick, asking Buildbucket for the build status
[10:33:34.001] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:33:34.001] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:168:0) after 1m0s
[10:34:34.035] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:168:0)
[10:34:34.035] Timer tick, asking Buildbucket for the build status
[10:34:34.232] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:34:34.232] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:169:0) after 1m0s
[10:35:34.298] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:169:0)
[10:35:34.298] Timer tick, asking Buildbucket for the build status
[10:35:34.426] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:35:34.426] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:170:0) after 1m0s
[10:36:34.560] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:170:0)
[10:36:34.560] Timer tick, asking Buildbucket for the build status
[10:36:34.726] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:36:34.726] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:171:0) after 1m0s
[10:37:34.767] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:171:0)
[10:37:34.767] Timer tick, asking Buildbucket for the build status
[10:37:34.833] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:37:34.833] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:172:0) after 1m0s
[10:38:34.835] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:172:0)
[10:38:34.835] Timer tick, asking Buildbucket for the build status
[10:38:34.932] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:38:34.932] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:173:0) after 1m0s
[10:39:34.965] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:173:0)
[10:39:34.965] Timer tick, asking Buildbucket for the build status
[10:39:35.029] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:39:35.029] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:174:0) after 1m0s
[10:40:35.054] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:174:0)
[10:40:35.054] Timer tick, asking Buildbucket for the build status
[10:40:35.218] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:40:35.218] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:175:0) after 1m0s
[10:41:35.260] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:175:0)
[10:41:35.260] Timer tick, asking Buildbucket for the build status
[10:41:35.328] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:41:35.328] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:176:0) after 1m0s
[10:42:35.398] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:176:0)
[10:42:35.398] Timer tick, asking Buildbucket for the build status
[10:42:35.479] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:42:35.479] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:177:0) after 1m0s
[10:43:35.538] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:177:0)
[10:43:35.538] Timer tick, asking Buildbucket for the build status
[10:43:35.678] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:43:35.678] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:178:0) after 1m0s
[10:44:36.887] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:178:0)
[10:44:36.887] Timer tick, asking Buildbucket for the build status
[10:44:36.972] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:44:36.972] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:179:0) after 1m0s
[10:45:37.082] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:179:0)
[10:45:37.082] Timer tick, asking Buildbucket for the build status
[10:45:37.268] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:45:37.268] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:180:0) after 1m0s
[10:46:37.387] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:180:0)
[10:46:37.387] Timer tick, asking Buildbucket for the build status
[10:46:37.447] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:46:37.447] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:181:0) after 1m0s
[10:47:37.667] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:181:0)
[10:47:37.668] Timer tick, asking Buildbucket for the build status
[10:47:38.142] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:47:38.142] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:182:0) after 1m0s
[10:48:39.361] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:182:0)
[10:48:39.361] Timer tick, asking Buildbucket for the build status
[10:48:39.917] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:48:39.917] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:183:0) after 1m0s
[10:49:40.108] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:183:0)
[10:49:40.108] Timer tick, asking Buildbucket for the build status
[10:49:40.172] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:49:40.172] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:184:0) after 1m0s
[10:50:40.323] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:184:0)
[10:50:40.323] Timer tick, asking Buildbucket for the build status
[10:50:40.382] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:50:40.382] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:185:0) after 1m0s
[10:51:40.531] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:185:0)
[10:51:40.531] Timer tick, asking Buildbucket for the build status
[10:51:40.593] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:51:40.593] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:186:0) after 1m0s
[10:52:40.749] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:186:0)
[10:52:40.749] Timer tick, asking Buildbucket for the build status
[10:52:40.818] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:52:40.818] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:187:0) after 1m0s
[10:53:41.033] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:187:0)
[10:53:41.033] Timer tick, asking Buildbucket for the build status
[10:53:41.126] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:53:41.126] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:188:0) after 1m0s
[10:54:41.360] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:188:0)
[10:54:41.360] Timer tick, asking Buildbucket for the build status
[10:54:41.422] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:54:41.423] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:189:0) after 1m0s
[10:55:41.489] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:189:0)
[10:55:41.489] Timer tick, asking Buildbucket for the build status
[10:55:41.549] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:55:41.549] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:190:0) after 1m0s
[10:56:41.723] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:190:0)
[10:56:41.723] Timer tick, asking Buildbucket for the build status
[10:56:41.843] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:56:41.843] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:191:0) after 1m0s
[10:57:42.003] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:191:0)
[10:57:42.003] Timer tick, asking Buildbucket for the build status
[10:57:42.209] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:57:42.209] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:192:0) after 1m0s
[10:58:42.330] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:192:0)
[10:58:42.330] Timer tick, asking Buildbucket for the build status
[10:58:42.429] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:58:42.429] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:193:0) after 1m0s
[10:59:42.613] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:193:0)
[10:59:42.613] Timer tick, asking Buildbucket for the build status
[10:59:42.663] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:59:42.663] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:194:0) after 1m0s
[11:00:42.828] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:194:0)
[11:00:42.828] Timer tick, asking Buildbucket for the build status
[11:00:42.908] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:00:42.908] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:195:0) after 1m0s
[11:01:43.053] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:195:0)
[11:01:43.053] Timer tick, asking Buildbucket for the build status
[11:01:43.106] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:01:43.106] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:196:0) after 1m0s
[11:02:43.245] Handling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:196:0)
[11:02:43.245] Timer tick, asking Buildbucket for the build status
[11:02:43.305] Build 8862947875236234208: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:02:43.305] Scheduling timer "check-buildbucket-build-status" (infra/Build From Tarball:9028377937205372240:197:0) after 1m0s
[11:03:29.432] Received PubSub notification, asking Buildbucket for the build status
[11:03:29.758] Build 8862947875236234208: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[11:03:29.758] Buildbucket build:
{
  "build": {
    "bucket": "luci.infra.cron",
    "canary_preference": "PROD",
    "completed_ts": "1606043008210787",
    "created_by": "project:infra",
    "created_ts": "1606031265947587",
    "id": "8862947875236234208",
    "parameters_json": "{\"builder_name\": \"Build From Tarball\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"buildbucket\": {\"properties\": {\"version\": \"89.0.4332.2\"}, \"tags\": [\"parent_buildername:publish_tarball\", \"user_agent:recipe\"]}, \"id\": \"9d3931ff-244a-44a7-a230-828908b19e93\", \"title\": \"publish_tarball/0\"}]}, \"version\": \"89.0.4332.2\"}}",
    "project": "infra",
    "result": "SUCCESS",
    "result_details_json": "{\"properties\": {}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-infra-cron-xenial-large-0-sr99\"], \"image\": [\"chrome-xenial-20111600-a937a23cefb\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-standard-32\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16\", \"Ubuntu-16.04\", \"Ubuntu-16.04.6\"], \"pool\": [\"luci.infra.cron\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5637-4d8b832\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-b\"]}}}",
    "service_account": "chromium-tarball-builder@chops-service-accounts.iam.gserviceaccount.com",
    "started_ts": "1606031308614790",
    "status": "COMPLETED",
    "status_changed_ts": "1606043008553536",
    "tags": [
      "builder:Build From Tarball",
      "parent_buildername:publish_tarball",
      "scheduler_invocation_id:9028377937205372240",
      "scheduler_job_id:infra/Build From Tarball",
      "swarming_hostname:chromium-swarm.appspot.com",
      "swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8862947875236234208/+/annotations",
      "swarming_tag:luci_project:infra",
      "swarming_tag:os:Linux",
      "swarming_tag:recipe_name:build_from_tarball",
      "swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/infra/infra",
      "swarming_task_id:5007bddbad455410",
      "user_agent:luci-scheduler",
      "user_agent:recipe"
    ],
    "updated_ts": "1606043008580114",
    "url": "https://ci.chromium.org/b/8862947875236234208",
    "utcnow_ts": "1606043009742282"
  }
}
[11:03:29.758] Invocation finished in 3h15m45.072222101s with status SUCCEEDED