[15:44:01.514] New invocation is queued and will start shortly
[15:44:03.628] Starting the invocation (attempt 1)
[15:44:03.652] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/a71ca9b27c675a6b37c64089f6d742206ad7e8d0"
[15:44:03.652] Popped gitiles commit info from properties and tags
[15:44:03.652] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[15:44:03.653] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[15:44:03.653] Buildbucket request:
{
"requestId": "8857300899681945328",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8857300899681945328",
"job": "fuchsia/toolchain.ci-clang-mac-x64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "f010621809b3fab9f3d64fa39699ea5c0c11e699"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@f010621809b3fab9f3d64fa39699ea5c0c11e699",
"title": "f010621809b3fab9f3d64fa39699ea5c0c11e699",
"url": "https://llvm.googlesource.com/llvm-project/+/f010621809b3fab9f3d64fa39699ea5c0c11e699"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "a3ebe650d3f3751786af10b4d6b17a3a59b9a332"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@a3ebe650d3f3751786af10b4d6b17a3a59b9a332",
"title": "a3ebe650d3f3751786af10b4d6b17a3a59b9a332",
"url": "https://llvm.googlesource.com/llvm-project/+/a3ebe650d3f3751786af10b4d6b17a3a59b9a332"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "17a17fa81c48ad2c1cd36f27c317d964e86ecf1b"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@17a17fa81c48ad2c1cd36f27c317d964e86ecf1b",
"title": "17a17fa81c48ad2c1cd36f27c317d964e86ecf1b",
"url": "https://llvm.googlesource.com/llvm-project/+/17a17fa81c48ad2c1cd36f27c317d964e86ecf1b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "afec4c28d55acc81315a4ef4fb7bcf319da7c830"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@afec4c28d55acc81315a4ef4fb7bcf319da7c830",
"title": "afec4c28d55acc81315a4ef4fb7bcf319da7c830",
"url": "https://llvm.googlesource.com/llvm-project/+/afec4c28d55acc81315a4ef4fb7bcf319da7c830"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "0df9098c2563a7c2cf2a78b1514492f057bec1c8"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@0df9098c2563a7c2cf2a78b1514492f057bec1c8",
"title": "0df9098c2563a7c2cf2a78b1514492f057bec1c8",
"url": "https://llvm.googlesource.com/llvm-project/+/0df9098c2563a7c2cf2a78b1514492f057bec1c8"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "6e738e187055bbd33b6c3d203b6b55904dfcb624"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@6e738e187055bbd33b6c3d203b6b55904dfcb624",
"title": "6e738e187055bbd33b6c3d203b6b55904dfcb624",
"url": "https://llvm.googlesource.com/llvm-project/+/6e738e187055bbd33b6c3d203b6b55904dfcb624"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "a71ca9b27c675a6b37c64089f6d742206ad7e8d0"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@a71ca9b27c675a6b37c64089f6d742206ad7e8d0",
"title": "a71ca9b27c675a6b37c64089f6d742206ad7e8d0",
"url": "https://llvm.googlesource.com/llvm-project/+/a71ca9b27c675a6b37c64089f6d742206ad7e8d0"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "a71ca9b27c675a6b37c64089f6d742206ad7e8d0",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8857300899681945328"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/toolchain.ci-clang-mac-x64-40be1bb5"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[15:44:04.004] Scheduled build:
{
"id": "8691870836731449185",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2026-01-23T15:44:03.696406095Z",
"updateTime": "2026-01-23T15:44:03.696406095Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "a71ca9b27c675a6b37c64089f6d742206ad7e8d0",
"ref": "refs/heads/main"
}
}
}
[15:44:04.004] Task URL: https://cr-buildbucket.appspot.com/build/8691870836731449185
[15:44:04.004] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:2:0) after 5m19s
[15:44:06.047] Received PubSub notification, asking Buildbucket for the build status
[15:44:06.068] Build status: SCHEDULED
[15:44:11.696] Received PubSub notification, asking Buildbucket for the build status
[15:44:11.719] Build status: STARTED
[15:49:23.019] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:2:0)
[15:49:23.056] Build status: STARTED
[15:49:23.056] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:5:0) after 5m51s
[15:55:14.136] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:5:0)
[15:55:14.218] Build status: STARTED
[15:55:14.218] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:6:0) after 5m17s
[16:00:31.235] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:6:0)
[16:00:31.260] Build status: STARTED
[16:00:31.260] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:7:0) after 1m44s
[16:02:15.274] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:7:0)
[16:02:15.300] Build status: STARTED
[16:02:15.300] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:8:0) after 7m19s
[16:09:34.320] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:8:0)
[16:09:34.347] Build status: STARTED
[16:09:34.347] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:9:0) after 2m33s
[16:12:07.408] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:9:0)
[16:12:07.516] Build status: STARTED
[16:12:07.516] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:10:0) after 5m32s
[16:17:39.528] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:10:0)
[16:17:39.542] Build status: STARTED
[16:17:39.542] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:11:0) after 5m0s
[16:22:39.548] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:11:0)
[16:22:39.661] Build status: STARTED
[16:22:39.661] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:12:0) after 2m14s
[16:24:53.675] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:12:0)
[16:24:53.696] Build status: STARTED
[16:24:53.696] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:13:0) after 5m30s
[16:30:23.850] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:13:0)
[16:30:23.870] Build status: STARTED
[16:30:23.870] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:14:0) after 9m36s
[16:39:59.876] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:14:0)
[16:39:59.893] Build status: STARTED
[16:39:59.893] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:15:0) after 9m14s
[16:49:13.960] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:15:0)
[16:49:13.974] Build status: STARTED
[16:49:13.974] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:16:0) after 1m22s
[16:50:36.015] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:16:0)
[16:50:36.032] Build status: STARTED
[16:50:36.032] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:17:0) after 8m29s
[16:59:05.133] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:17:0)
[16:59:05.187] Build status: STARTED
[16:59:05.187] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:18:0) after 1m52s
[17:00:57.249] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:18:0)
[17:00:57.263] Build status: STARTED
[17:00:57.263] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:19:0) after 4m35s
[17:05:32.326] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:19:0)
[17:05:32.345] Build status: STARTED
[17:05:32.345] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:20:0) after 7m46s
[17:13:18.375] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:20:0)
[17:13:18.388] Build status: STARTED
[17:13:18.388] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:21:0) after 5m55s
[17:19:13.403] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:21:0)
[17:19:13.475] Build status: STARTED
[17:19:13.475] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8857300899681945328:22:0) after 8m37s
[17:23:13.673] Received PubSub notification, asking Buildbucket for the build status
[17:23:13.702] Build:
{
"id": "8691870836731449185",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2026-01-23T15:44:03.696406095Z",
"startTime": "2026-01-23T15:44:09.368603585Z",
"endTime": "2026-01-23T17:23:12.964393878Z",
"updateTime": "2026-01-23T17:23:12.964393878Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "a71ca9b27c675a6b37c64089f6d742206ad7e8d0",
"ref": "refs/heads/main"
}
}
}
[17:23:13.702] Invocation finished in 1h39m12.203711955s with status SUCCEEDED