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

Definition (rev 87e0f3400b0aac78b81573f56efb8257c68089b2)

buildbucket: <
  server: "cr-buildbucket.appspot.com"
  bucket: "ci"
  builder: "win"
>

Incoming triggers

Incoming properties

{
  "branch": "refs/heads/main",
  "repository": "https://r8.googlesource.com/r8",
  "revision": "79bd836c80b5a6a314b2f6124dbfbbff5f2517dc"
}

Incoming tags

  • buildset:commit/gitiles/r8.googlesource.com/r8/+/79bd836c80b5a6a314b2f6124dbfbbff5f2517dc
  • gitiles_ref:refs/heads/main

Debug log (UTC)

[19:50:14.114] New invocation is queued and will start shortly
[19:50:16.091] Starting the invocation (attempt 1)
[19:50:16.113] Popped buildset tag "buildset:commit/gitiles/r8.googlesource.com/r8/+/79bd836c80b5a6a314b2f6124dbfbbff5f2517dc"
[19:50:16.113] Popped gitiles commit info from properties and tags
[19:50:16.113] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[19:50:16.113] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[19:50:16.114] Buildbucket request:
{
  "requestId": "8904577025937851392",
  "builder": {
    "project": "r8",
    "bucket": "ci",
    "builder": "win"
  },
  "properties": {
      "$recipe_engine/scheduler": {
            "hostname": "luci-scheduler.appspot.com",
            "invocation": "8904577025937851392",
            "job": "r8/win",
            "triggers": [
                  {
                        "gitiles": {
                              "ref": "refs/heads/main",
                              "repo": "https://r8.googlesource.com/r8",
                              "revision": "79bd836c80b5a6a314b2f6124dbfbbff5f2517dc"
                            },
                        "id": "https://r8.googlesource.com/r8/+/refs/heads/main@79bd836c80b5a6a314b2f6124dbfbbff5f2517dc",
                        "title": "79bd836c80b5a6a314b2f6124dbfbbff5f2517dc",
                        "url": "https://r8.googlesource.com/r8/+/79bd836c80b5a6a314b2f6124dbfbbff5f2517dc"
                      }
                ]
          }
    },
  "gitilesCommit": {
    "host": "r8.googlesource.com",
    "project": "r8",
    "id": "79bd836c80b5a6a314b2f6124dbfbbff5f2517dc",
    "ref": "refs/heads/main"
  },
  "tags": [
    {
      "key": "scheduler_invocation_id",
      "value": "8904577025937851392"
    },
    {
      "key": "scheduler_job_id",
      "value": "r8/win"
    },
    {
      "key": "user_agent",
      "value": "luci-scheduler"
    }
  ],
  "notify": {
    "pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
  }
}
[19:50:16.824] Scheduled build:
{
  "id": "8739146962971585281",
  "builder": {
    "project": "r8",
    "bucket": "ci",
    "builder": "win"
  },
  "number": 144,
  "createdBy": "project:r8",
  "createTime": "2024-08-19T19:50:16.322107564Z",
  "updateTime": "2024-08-19T19:50:16.322107564Z",
  "status": "SCHEDULED",
  "input": {
    "gitilesCommit": {
      "host": "r8.googlesource.com",
      "project": "r8",
      "id": "79bd836c80b5a6a314b2f6124dbfbbff5f2517dc",
      "ref": "refs/heads/main"
    }
  }
}
[19:50:16.824] Task URL: https://cr-buildbucket.appspot.com/build/8739146962971585281
[19:50:16.824] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:2:0) after 8m11s
[19:50:17.728] Received PubSub notification, asking Buildbucket for the build status
[19:50:17.796] Build status: SCHEDULED
[19:58:27.863] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:2:0)
[19:58:27.901] Build status: SCHEDULED
[19:58:27.901] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:4:0) after 5m36s
[20:04:03.952] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:4:0)
[20:04:03.980] Build status: SCHEDULED
[20:04:03.980] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:5:0) after 4m12s
[20:08:16.032] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:5:0)
[20:08:16.053] Build status: SCHEDULED
[20:08:16.054] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:6:0) after 9m33s
[20:17:49.082] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:6:0)
[20:17:49.197] Build status: SCHEDULED
[20:17:49.197] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:7:0) after 8m50s
[20:26:39.186] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:7:0)
[20:26:39.225] Build status: SCHEDULED
[20:26:39.225] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:8:0) after 4m17s
[20:30:56.374] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:8:0)
[20:30:56.393] Build status: SCHEDULED
[20:30:56.393] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:9:0) after 9m34s
[20:40:30.425] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:9:0)
[20:40:30.443] Build status: SCHEDULED
[20:40:30.443] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:10:0) after 7m21s
[20:47:51.451] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:10:0)
[20:47:51.477] Build status: SCHEDULED
[20:47:51.477] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:11:0) after 3m17s
[20:51:08.548] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:11:0)
[20:51:08.568] Build status: SCHEDULED
[20:51:08.568] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:12:0) after 9m50s
[21:00:58.604] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:12:0)
[21:00:58.645] Build status: SCHEDULED
[21:00:58.645] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:13:0) after 2m1s
[21:02:59.663] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:13:0)
[21:02:59.734] Build status: SCHEDULED
[21:02:59.734] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:14:0) after 1m5s
[21:04:04.791] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:14:0)
[21:04:04.809] Build status: SCHEDULED
[21:04:04.809] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:15:0) after 5m45s
[21:09:49.994] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:15:0)
[21:09:50.074] Build status: SCHEDULED
[21:09:50.074] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:16:0) after 3m28s
[21:13:18.292] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:16:0)
[21:13:18.380] Build status: SCHEDULED
[21:13:18.380] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:17:0) after 4m6s
[21:17:24.382] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:17:0)
[21:17:24.422] Build status: SCHEDULED
[21:17:24.423] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:18:0) after 5m55s
[21:23:19.454] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:18:0)
[21:23:19.508] Build status: SCHEDULED
[21:23:19.508] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:19:0) after 4m12s
[21:27:31.574] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:19:0)
[21:27:31.601] Build status: SCHEDULED
[21:27:31.601] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:20:0) after 6m3s
[21:33:34.667] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:20:0)
[21:33:34.684] Build status: SCHEDULED
[21:33:34.684] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:21:0) after 5m49s
[21:39:23.699] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:21:0)
[21:39:23.717] Build status: SCHEDULED
[21:39:23.717] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:22:0) after 9m47s
[21:49:10.839] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:22:0)
[21:49:10.864] Build status: SCHEDULED
[21:49:10.864] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:23:0) after 1m49s
[21:50:59.872] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:23:0)
[21:50:59.903] Build status: SCHEDULED
[21:50:59.903] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:24:0) after 3m15s
[21:54:14.917] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:24:0)
[21:54:14.938] Build status: SCHEDULED
[21:54:14.938] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:25:0) after 1m8s
[21:55:23.002] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:25:0)
[21:55:23.061] Build status: SCHEDULED
[21:55:23.061] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:26:0) after 2m11s
[21:57:34.123] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:26:0)
[21:57:34.159] Build status: SCHEDULED
[21:57:34.159] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:27:0) after 5m24s
[22:02:58.180] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:27:0)
[22:02:58.207] Build status: SCHEDULED
[22:02:58.208] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:28:0) after 6m32s
[22:09:30.228] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:28:0)
[22:09:30.247] Build status: SCHEDULED
[22:09:30.247] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:29:0) after 6m23s
[22:15:53.266] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:29:0)
[22:15:53.285] Build status: SCHEDULED
[22:15:53.285] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:30:0) after 7m0s
[22:22:53.275] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:30:0)
[22:22:53.419] Build status: SCHEDULED
[22:22:53.419] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:31:0) after 6m4s
[22:28:57.436] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:31:0)
[22:28:57.543] Build status: SCHEDULED
[22:28:57.543] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:32:0) after 9m57s
[22:38:54.694] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:32:0)
[22:38:54.711] Build status: SCHEDULED
[22:38:54.711] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:33:0) after 6m41s
[22:45:35.750] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:33:0)
[22:45:35.860] Build status: SCHEDULED
[22:45:35.861] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:34:0) after 7m33s
[22:53:08.852] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:34:0)
[22:53:08.877] Build status: SCHEDULED
[22:53:08.877] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:35:0) after 4m54s
[22:58:02.871] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:35:0)
[22:58:02.902] Build status: SCHEDULED
[22:58:02.902] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:36:0) after 5m44s
[23:03:46.923] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:36:0)
[23:03:46.943] Build status: SCHEDULED
[23:03:46.943] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:37:0) after 2m25s
[23:06:11.974] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:37:0)
[23:06:12.053] Build status: SCHEDULED
[23:06:12.053] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:38:0) after 9m51s
[23:16:03.120] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:38:0)
[23:16:03.150] Build status: SCHEDULED
[23:16:03.150] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:39:0) after 8m37s
[23:24:40.154] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:39:0)
[23:24:40.234] Build status: SCHEDULED
[23:24:40.234] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:40:0) after 5m57s
[23:30:37.264] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:40:0)
[23:30:37.297] Build status: SCHEDULED
[23:30:37.297] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:41:0) after 7m14s
[23:37:51.310] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:41:0)
[23:37:51.329] Build status: SCHEDULED
[23:37:51.329] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:42:0) after 3m32s
[23:41:23.355] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:42:0)
[23:41:23.374] Build status: SCHEDULED
[23:41:23.374] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:43:0) after 1m54s
[23:43:17.406] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:43:0)
[23:43:17.429] Build status: SCHEDULED
[23:43:17.429] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:44:0) after 9m26s
[23:52:43.436] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:44:0)
[23:52:43.549] Build status: SCHEDULED
[23:52:43.549] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:45:0) after 6m47s
[23:59:30.576] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:45:0)
[23:59:30.594] Build status: SCHEDULED
[23:59:30.594] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:46:0) after 8m2s
[00:07:32.626] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:46:0)
[00:07:32.706] Build status: SCHEDULED
[00:07:32.706] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:47:0) after 6m50s
[00:14:22.742] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:47:0)
[00:14:22.769] Build status: SCHEDULED
[00:14:22.769] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:48:0) after 4m9s
[00:18:31.798] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:48:0)
[00:18:32.083] Build status: SCHEDULED
[00:18:32.083] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:49:0) after 3m26s
[00:21:58.114] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:49:0)
[00:21:58.190] Build status: SCHEDULED
[00:21:58.190] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:50:0) after 4m58s
[00:26:56.231] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:50:0)
[00:26:56.369] Build status: SCHEDULED
[00:26:56.369] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:51:0) after 2m13s
[00:29:09.445] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:51:0)
[00:29:09.477] Build status: SCHEDULED
[00:29:09.477] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:52:0) after 2m16s
[00:31:25.498] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:52:0)
[00:31:25.528] Build status: SCHEDULED
[00:31:25.528] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:53:0) after 4m27s
[00:35:52.656] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:53:0)
[00:35:52.675] Build status: SCHEDULED
[00:35:52.675] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:54:0) after 1m32s
[00:37:24.717] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:54:0)
[00:37:24.769] Build status: SCHEDULED
[00:37:24.769] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:55:0) after 2m46s
[00:40:10.783] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:55:0)
[00:40:10.803] Build status: SCHEDULED
[00:40:10.803] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:56:0) after 8m41s
[00:48:51.817] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:56:0)
[00:48:51.844] Build status: SCHEDULED
[00:48:51.844] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:57:0) after 8m18s
[00:57:09.865] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:57:0)
[00:57:09.881] Build status: SCHEDULED
[00:57:09.881] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:58:0) after 1m47s
[00:58:56.914] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:58:0)
[00:58:56.937] Build status: SCHEDULED
[00:58:56.937] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:59:0) after 1m15s
[01:00:12.007] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:59:0)
[01:00:12.074] Build status: SCHEDULED
[01:00:12.074] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:60:0) after 9m34s
[01:09:46.098] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:60:0)
[01:09:46.131] Build status: SCHEDULED
[01:09:46.131] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:61:0) after 7m47s
[01:17:33.140] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:61:0)
[01:17:33.341] Build status: SCHEDULED
[01:17:33.341] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:62:0) after 8m58s
[01:24:03.185] Received PubSub notification, asking Buildbucket for the build status
[01:24:03.206] Build status: STARTED
[01:26:31.362] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:62:0)
[01:26:31.485] Build status: STARTED
[01:26:31.485] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:64:0) after 8m25s
[01:34:56.537] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:64:0)
[01:34:56.584] Build status: STARTED
[01:34:56.584] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:65:0) after 6m48s
[01:41:44.608] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:65:0)
[01:41:44.689] Build status: STARTED
[01:41:44.689] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:66:0) after 8m3s
[01:49:47.705] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:66:0)
[01:49:47.734] Build status: STARTED
[01:49:47.734] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:67:0) after 8m2s
[01:57:49.781] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:67:0)
[01:57:49.798] Build status: STARTED
[01:57:49.798] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:68:0) after 6m23s
[02:04:12.820] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:68:0)
[02:04:12.915] Build status: STARTED
[02:04:12.915] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:69:0) after 8m58s
[02:13:10.980] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:69:0)
[02:13:11.012] Build status: STARTED
[02:13:11.012] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:70:0) after 5m45s
[02:18:56.045] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:70:0)
[02:18:56.076] Build status: STARTED
[02:18:56.076] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:71:0) after 9m16s
[02:28:12.095] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:71:0)
[02:28:12.178] Build status: STARTED
[02:28:12.178] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:72:0) after 3m50s
[02:32:02.197] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:72:0)
[02:32:02.244] Build status: STARTED
[02:32:02.244] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:73:0) after 8m29s
[02:40:31.297] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:73:0)
[02:40:31.316] Build status: STARTED
[02:40:31.316] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:74:0) after 2m1s
[02:42:32.330] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:74:0)
[02:42:32.350] Build status: STARTED
[02:42:32.350] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:75:0) after 7m55s
[02:50:27.371] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:75:0)
[02:50:27.436] Build status: STARTED
[02:50:27.436] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:76:0) after 1m0s
[02:51:27.605] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:76:0)
[02:51:27.629] Build status: STARTED
[02:51:27.629] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:77:0) after 8m13s
[02:59:40.609] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:77:0)
[02:59:40.638] Build status: STARTED
[02:59:40.638] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:78:0) after 3m1s
[03:02:41.662] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:78:0)
[03:02:41.686] Build status: STARTED
[03:02:41.686] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:79:0) after 3m31s
[03:06:12.664] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:79:0)
[03:06:12.696] Build status: STARTED
[03:06:12.696] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:80:0) after 7m3s
[03:13:15.763] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:80:0)
[03:13:15.793] Build status: STARTED
[03:13:15.793] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:81:0) after 6m27s
[03:19:42.870] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:81:0)
[03:19:42.896] Build status: STARTED
[03:19:42.896] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:82:0) after 3m32s
[03:23:14.913] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:82:0)
[03:23:14.949] Build status: STARTED
[03:23:14.949] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:83:0) after 8m51s
[03:32:05.991] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:83:0)
[03:32:06.028] Build status: STARTED
[03:32:06.028] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:84:0) after 8m16s
[03:40:22.356] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:84:0)
[03:40:22.437] Build status: STARTED
[03:40:22.437] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:85:0) after 1m50s
[03:42:12.475] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:85:0)
[03:42:12.492] Build status: STARTED
[03:42:12.492] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:86:0) after 4m43s
[03:46:55.504] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:86:0)
[03:46:55.584] Build status: STARTED
[03:46:55.584] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:87:0) after 4m45s
[03:51:40.628] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:87:0)
[03:51:40.644] Build status: STARTED
[03:51:40.644] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:88:0) after 3m52s
[03:55:32.743] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:88:0)
[03:55:32.803] Build status: STARTED
[03:55:32.803] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:89:0) after 6m38s
[04:02:10.974] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:89:0)
[04:02:11.042] Build status: STARTED
[04:02:11.042] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:90:0) after 4m17s
[04:06:28.065] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:90:0)
[04:06:28.092] Build status: STARTED
[04:06:28.092] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:91:0) after 1m29s
[04:07:57.116] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:91:0)
[04:07:57.137] Build status: STARTED
[04:07:57.137] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:92:0) after 5m20s
[04:13:17.160] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:92:0)
[04:13:17.196] Build status: STARTED
[04:13:17.196] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:93:0) after 4m22s
[04:17:39.216] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:93:0)
[04:17:39.244] Build status: STARTED
[04:17:39.244] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:94:0) after 7m18s
[04:24:57.270] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:94:0)
[04:24:57.292] Build status: STARTED
[04:24:57.292] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:95:0) after 8m55s
[04:33:52.370] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:95:0)
[04:33:52.395] Build status: STARTED
[04:33:52.395] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:96:0) after 2m3s
[04:35:55.487] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:96:0)
[04:35:55.517] Build status: STARTED
[04:35:55.517] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:97:0) after 2m41s
[04:38:36.899] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:97:0)
[04:38:36.925] Build status: STARTED
[04:38:36.925] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:98:0) after 5m42s
[04:44:18.952] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:98:0)
[04:44:18.970] Build status: STARTED
[04:44:18.970] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:99:0) after 8m42s
[04:53:00.987] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:99:0)
[04:53:01.025] Build status: STARTED
[04:53:01.025] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:100:0) after 6m25s
[04:59:26.047] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:100:0)
[04:59:26.068] Build status: STARTED
[04:59:26.068] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:101:0) after 4m18s
[05:03:44.097] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:101:0)
[05:03:44.128] Build status: STARTED
[05:03:44.128] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:102:0) after 3m15s
[05:06:59.144] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:102:0)
[05:06:59.169] Build status: STARTED
[05:06:59.169] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:103:0) after 6m41s
[05:13:40.185] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:103:0)
[05:13:40.214] Build status: STARTED
[05:13:40.214] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:104:0) after 4m55s
[05:18:35.231] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:104:0)
[05:18:35.259] Build status: STARTED
[05:18:35.259] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:105:0) after 3m9s
[05:21:44.285] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:105:0)
[05:21:44.362] Build status: STARTED
[05:21:44.362] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:106:0) after 3m1s
[05:24:45.381] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:106:0)
[05:24:45.404] Build status: STARTED
[05:24:45.404] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:107:0) after 7m55s
[05:32:40.416] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:107:0)
[05:32:40.503] Build status: STARTED
[05:32:40.503] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:108:0) after 5m50s
[05:38:30.496] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:108:0)
[05:38:30.527] Build status: STARTED
[05:38:30.527] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:109:0) after 8m43s
[05:47:13.548] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:109:0)
[05:47:13.565] Build status: STARTED
[05:47:13.565] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:110:0) after 2m27s
[05:49:40.601] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:110:0)
[05:49:40.621] Build status: STARTED
[05:49:40.621] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:111:0) after 4m41s
[05:54:21.687] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:111:0)
[05:54:21.710] Build status: STARTED
[05:54:21.710] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:112:0) after 8m4s
[06:02:25.831] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:112:0)
[06:02:25.849] Build status: STARTED
[06:02:25.849] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:113:0) after 3m23s
[06:05:48.930] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:113:0)
[06:05:49.039] Build status: STARTED
[06:05:49.039] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:114:0) after 4m18s
[06:10:07.047] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:114:0)
[06:10:07.066] Build status: STARTED
[06:10:07.066] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:115:0) after 3m31s
[06:13:38.055] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:115:0)
[06:13:38.086] Build status: STARTED
[06:13:38.086] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:116:0) after 6m32s
[06:20:10.194] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:116:0)
[06:20:10.212] Build status: STARTED
[06:20:10.212] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:117:0) after 6m5s
[06:26:15.238] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:117:0)
[06:26:15.270] Build status: STARTED
[06:26:15.270] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:118:0) after 7m53s
[06:34:08.769] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:118:0)
[06:34:08.792] Build status: STARTED
[06:34:08.792] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:119:0) after 9m1s
[06:43:09.912] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:119:0)
[06:43:09.929] Build status: STARTED
[06:43:09.929] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:120:0) after 2m37s
[06:45:46.988] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:120:0)
[06:45:47.032] Build status: STARTED
[06:45:47.032] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:121:0) after 8m18s
[06:54:05.123] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:121:0)
[06:54:05.143] Build status: STARTED
[06:54:05.143] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:122:0) after 1m31s
[06:55:36.190] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:122:0)
[06:55:36.205] Build status: STARTED
[06:55:36.205] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:123:0) after 3m6s
[06:58:42.314] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:123:0)
[06:58:42.347] Build status: STARTED
[06:58:42.347] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:124:0) after 4m18s
[07:03:00.913] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:124:0)
[07:03:00.933] Build status: STARTED
[07:03:00.933] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:125:0) after 9m19s
[07:12:19.963] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:125:0)
[07:12:19.987] Build status: STARTED
[07:12:19.987] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:126:0) after 9m34s
[07:21:54.053] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:126:0)
[07:21:54.083] Build status: STARTED
[07:21:54.083] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:127:0) after 8m10s
[07:30:04.162] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:127:0)
[07:30:04.451] Build status: STARTED
[07:30:04.451] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:128:0) after 9m24s
[07:39:28.473] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:128:0)
[07:39:28.492] Build status: STARTED
[07:39:28.492] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:129:0) after 9m37s
[07:49:05.485] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:129:0)
[07:49:05.506] Build status: STARTED
[07:49:05.506] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:130:0) after 9m52s
[07:58:57.536] Handling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:130:0)
[07:58:57.568] Build status: STARTED
[07:58:57.568] Scheduling timer "check-buildbucket-build-status" (r8/win:8904577025937851392:131:0) after 6m12s
[08:00:19.570] Received PubSub notification, asking Buildbucket for the build status
[08:00:19.590] Build:
{
  "id": "8739146962971585281",
  "builder": {
    "project": "r8",
    "bucket": "ci",
    "builder": "win"
  },
  "number": 144,
  "createdBy": "project:r8",
  "createTime": "2024-08-19T19:50:16.322107564Z",
  "startTime": "2024-08-20T01:24:02.891817895Z",
  "endTime": "2024-08-20T08:00:19.344246630Z",
  "updateTime": "2024-08-20T08:00:19.344246630Z",
  "status": "FAILURE",
  "input": {
    "gitilesCommit": {
      "host": "r8.googlesource.com",
      "project": "r8",
      "id": "79bd836c80b5a6a314b2f6124dbfbbff5f2517dc",
      "ref": "refs/heads/main"
    }
  }
}
[08:00:19.590] Invocation finished in 12h10m5.481335241s with status FAILED