[20:04:12.292] New invocation is queued and will start shortly
[20:04:13.365] Starting the invocation (attempt 1)
[20:04:13.392] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/c7593344f48e64af29fd9512852f24f9ebe5a4c6"
[20:04:13.392] Popped gitiles commit info from properties and tags
[20:04:13.392] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[20:04:13.392] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[20:04:13.392] Buildbucket request:
{
"requestId": "8911552113460092304",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8911552113460092304",
"job": "fuchsia/toolchain.ci-clang-mac-x64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "68f4e46c432ea2f1f8d33c6dc9345f6e2afeec4a"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@68f4e46c432ea2f1f8d33c6dc9345f6e2afeec4a",
"title": "68f4e46c432ea2f1f8d33c6dc9345f6e2afeec4a",
"url": "https://llvm.googlesource.com/llvm-project/+/68f4e46c432ea2f1f8d33c6dc9345f6e2afeec4a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "0525c201b657395bfdf27d2a473c4c0adf753a21"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@0525c201b657395bfdf27d2a473c4c0adf753a21",
"title": "0525c201b657395bfdf27d2a473c4c0adf753a21",
"url": "https://llvm.googlesource.com/llvm-project/+/0525c201b657395bfdf27d2a473c4c0adf753a21"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "07b330132c0b7fd5b3ada1890840d0dbbd8cdb8e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@07b330132c0b7fd5b3ada1890840d0dbbd8cdb8e",
"title": "07b330132c0b7fd5b3ada1890840d0dbbd8cdb8e",
"url": "https://llvm.googlesource.com/llvm-project/+/07b330132c0b7fd5b3ada1890840d0dbbd8cdb8e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "cf3b37c92ffad21086a0741ac682c87abea9a5d6"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@cf3b37c92ffad21086a0741ac682c87abea9a5d6",
"title": "cf3b37c92ffad21086a0741ac682c87abea9a5d6",
"url": "https://llvm.googlesource.com/llvm-project/+/cf3b37c92ffad21086a0741ac682c87abea9a5d6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "c49bc1a3b782e38e4ffb5b274f1e7775af6c2315"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@c49bc1a3b782e38e4ffb5b274f1e7775af6c2315",
"title": "c49bc1a3b782e38e4ffb5b274f1e7775af6c2315",
"url": "https://llvm.googlesource.com/llvm-project/+/c49bc1a3b782e38e4ffb5b274f1e7775af6c2315"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "572b4e70cbfca2c60ac13a9483ddb0e0fbd8ec43"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@572b4e70cbfca2c60ac13a9483ddb0e0fbd8ec43",
"title": "572b4e70cbfca2c60ac13a9483ddb0e0fbd8ec43",
"url": "https://llvm.googlesource.com/llvm-project/+/572b4e70cbfca2c60ac13a9483ddb0e0fbd8ec43"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "13f6797826faedb910c7e8b1dfc1f134f3cef342"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@13f6797826faedb910c7e8b1dfc1f134f3cef342",
"title": "13f6797826faedb910c7e8b1dfc1f134f3cef342",
"url": "https://llvm.googlesource.com/llvm-project/+/13f6797826faedb910c7e8b1dfc1f134f3cef342"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "c7593344f48e64af29fd9512852f24f9ebe5a4c6"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@c7593344f48e64af29fd9512852f24f9ebe5a4c6",
"title": "c7593344f48e64af29fd9512852f24f9ebe5a4c6",
"url": "https://llvm.googlesource.com/llvm-project/+/c7593344f48e64af29fd9512852f24f9ebe5a4c6"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "c7593344f48e64af29fd9512852f24f9ebe5a4c6",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8911552113460092304"
},
{
"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"
}
}
[20:04:13.876] Scheduled build:
{
"id": "8746122051596546561",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2024-06-03T20:04:13.446503160Z",
"updateTime": "2024-06-03T20:04:13.446503160Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "c7593344f48e64af29fd9512852f24f9ebe5a4c6",
"ref": "refs/heads/main"
}
}
}
[20:04:13.876] Task URL: https://cr-buildbucket.appspot.com/build/8746122051596546561
[20:04:13.876] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:2:0) after 9m54s
[20:04:14.814] Received PubSub notification, asking Buildbucket for the build status
[20:04:14.832] Build status: SCHEDULED
[20:14:07.892] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:2:0)
[20:14:07.917] Build status: SCHEDULED
[20:14:07.917] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:4:0) after 3m0s
[20:15:08.246] Received PubSub notification, asking Buildbucket for the build status
[20:15:08.267] Build status: STARTED
[20:17:07.936] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:4:0)
[20:17:07.973] Build status: STARTED
[20:17:07.973] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:6:0) after 7m11s
[20:24:18.998] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:6:0)
[20:24:19.034] Build status: STARTED
[20:24:19.034] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:7:0) after 2m29s
[20:26:48.063] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:7:0)
[20:26:48.085] Build status: STARTED
[20:26:48.085] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:8:0) after 3m45s
[20:30:33.125] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:8:0)
[20:30:33.154] Build status: STARTED
[20:30:33.154] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:9:0) after 9m42s
[20:40:15.172] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:9:0)
[20:40:15.193] Build status: STARTED
[20:40:15.194] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:10:0) after 1m16s
[20:41:31.217] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:10:0)
[20:41:31.252] Build status: STARTED
[20:41:31.252] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:11:0) after 7m34s
[20:49:05.270] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:11:0)
[20:49:05.292] Build status: STARTED
[20:49:05.292] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:12:0) after 4m26s
[20:53:31.301] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:12:0)
[20:53:31.320] Build status: STARTED
[20:53:31.320] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:13:0) after 9m23s
[21:02:54.343] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:13:0)
[21:02:54.413] Build status: STARTED
[21:02:54.413] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:14:0) after 7m5s
[21:09:59.445] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:14:0)
[21:09:59.465] Build status: STARTED
[21:09:59.465] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:15:0) after 1m52s
[21:11:51.570] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:15:0)
[21:11:51.713] Build status: STARTED
[21:11:51.713] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:16:0) after 8m55s
[21:20:46.730] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:16:0)
[21:20:46.747] Build status: STARTED
[21:20:46.747] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:17:0) after 1m54s
[21:22:40.773] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:17:0)
[21:22:40.807] Build status: STARTED
[21:22:40.807] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8911552113460092304:18:0) after 5m45s
[21:28:05.169] Received PubSub notification, asking Buildbucket for the build status
[21:28:05.255] Build:
{
"id": "8746122051596546561",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2024-06-03T20:04:13.446503160Z",
"startTime": "2024-06-03T20:15:07.381184053Z",
"endTime": "2024-06-03T21:28:04.869555632Z",
"updateTime": "2024-06-03T21:28:04.869555632Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "c7593344f48e64af29fd9512852f24f9ebe5a4c6",
"ref": "refs/heads/main"
}
}
}
[21:28:05.255] Invocation finished in 1h23m52.969588425s with status SUCCEEDED