[09:12:25.371] New invocation is queued and will start shortly
[09:12:27.129] Starting the invocation (attempt 1)
[09:12:27.152] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/1c704353aa2cd398c9133fe95f3f89f2e0f06775"
[09:12:27.152] Popped gitiles commit info from properties and tags
[09:12:27.152] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[09:12:27.152] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[09:12:27.153] Buildbucket request:
{
"requestId": "8847994049622648208",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8847994049622648208",
"job": "fuchsia/toolchain.ci-clang-mac-x64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "d027cac061c76223bc1a001dcc2869021ec0d771"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@d027cac061c76223bc1a001dcc2869021ec0d771",
"title": "d027cac061c76223bc1a001dcc2869021ec0d771",
"url": "https://llvm.googlesource.com/llvm-project/+/d027cac061c76223bc1a001dcc2869021ec0d771"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "fa7454200d18d241ba35541e4647c4bfa7b8ab07"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@fa7454200d18d241ba35541e4647c4bfa7b8ab07",
"title": "fa7454200d18d241ba35541e4647c4bfa7b8ab07",
"url": "https://llvm.googlesource.com/llvm-project/+/fa7454200d18d241ba35541e4647c4bfa7b8ab07"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "7234297bf52c0acc4ac0798a50b566fc17041f15"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@7234297bf52c0acc4ac0798a50b566fc17041f15",
"title": "7234297bf52c0acc4ac0798a50b566fc17041f15",
"url": "https://llvm.googlesource.com/llvm-project/+/7234297bf52c0acc4ac0798a50b566fc17041f15"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "f9c0cf57d3339636a9aeeb0d4746de0659636e0b"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@f9c0cf57d3339636a9aeeb0d4746de0659636e0b",
"title": "f9c0cf57d3339636a9aeeb0d4746de0659636e0b",
"url": "https://llvm.googlesource.com/llvm-project/+/f9c0cf57d3339636a9aeeb0d4746de0659636e0b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "480f144d06a97f4b17849bb0414af399728a896e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@480f144d06a97f4b17849bb0414af399728a896e",
"title": "480f144d06a97f4b17849bb0414af399728a896e",
"url": "https://llvm.googlesource.com/llvm-project/+/480f144d06a97f4b17849bb0414af399728a896e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "915a1e55f65c36061c0a01f8ede7cc331cf3c9d5"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@915a1e55f65c36061c0a01f8ede7cc331cf3c9d5",
"title": "915a1e55f65c36061c0a01f8ede7cc331cf3c9d5",
"url": "https://llvm.googlesource.com/llvm-project/+/915a1e55f65c36061c0a01f8ede7cc331cf3c9d5"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "1fb93e83b32e765f4c132b3dca17fa5f76ce5334"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@1fb93e83b32e765f4c132b3dca17fa5f76ce5334",
"title": "1fb93e83b32e765f4c132b3dca17fa5f76ce5334",
"url": "https://llvm.googlesource.com/llvm-project/+/1fb93e83b32e765f4c132b3dca17fa5f76ce5334"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "7e1f6b6b22fb226c47b6c73caa2ebfc44bf881a5"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@7e1f6b6b22fb226c47b6c73caa2ebfc44bf881a5",
"title": "7e1f6b6b22fb226c47b6c73caa2ebfc44bf881a5",
"url": "https://llvm.googlesource.com/llvm-project/+/7e1f6b6b22fb226c47b6c73caa2ebfc44bf881a5"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "a257e2aa4eb47ad340915136228cd28d918e8dc2"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@a257e2aa4eb47ad340915136228cd28d918e8dc2",
"title": "a257e2aa4eb47ad340915136228cd28d918e8dc2",
"url": "https://llvm.googlesource.com/llvm-project/+/a257e2aa4eb47ad340915136228cd28d918e8dc2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "b9bcdab77f76a05eef8c61f0e52906c99fe12925"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@b9bcdab77f76a05eef8c61f0e52906c99fe12925",
"title": "b9bcdab77f76a05eef8c61f0e52906c99fe12925",
"url": "https://llvm.googlesource.com/llvm-project/+/b9bcdab77f76a05eef8c61f0e52906c99fe12925"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "1e52b49689d2410b77bb2e11ca1ca660fb367f48"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@1e52b49689d2410b77bb2e11ca1ca660fb367f48",
"title": "1e52b49689d2410b77bb2e11ca1ca660fb367f48",
"url": "https://llvm.googlesource.com/llvm-project/+/1e52b49689d2410b77bb2e11ca1ca660fb367f48"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "8d61b16c650b106a829ead7706b7c1b78bf0320c"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@8d61b16c650b106a829ead7706b7c1b78bf0320c",
"title": "8d61b16c650b106a829ead7706b7c1b78bf0320c",
"url": "https://llvm.googlesource.com/llvm-project/+/8d61b16c650b106a829ead7706b7c1b78bf0320c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "1c704353aa2cd398c9133fe95f3f89f2e0f06775"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@1c704353aa2cd398c9133fe95f3f89f2e0f06775",
"title": "1c704353aa2cd398c9133fe95f3f89f2e0f06775",
"url": "https://llvm.googlesource.com/llvm-project/+/1c704353aa2cd398c9133fe95f3f89f2e0f06775"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "1c704353aa2cd398c9133fe95f3f89f2e0f06775",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8847994049622648208"
},
{
"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"
}
}
[09:12:27.761] Scheduled build:
{
"id": "8682563986974863089",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2026-05-06T09:12:27.276337625Z",
"updateTime": "2026-05-06T09:12:27.276337625Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "1c704353aa2cd398c9133fe95f3f89f2e0f06775",
"ref": "refs/heads/main"
}
}
}
[09:12:27.762] Task URL: https://cr-buildbucket.appspot.com/build/8682563986974863089
[09:12:27.762] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:2:0) after 8m21s
[09:12:28.659] Received PubSub notification, asking Buildbucket for the build status
[09:12:28.688] Build status: SCHEDULED
[09:12:32.818] Received PubSub notification, asking Buildbucket for the build status
[09:12:32.847] Build status: STARTED
[09:20:48.756] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:2:0)
[09:20:48.777] Build status: STARTED
[09:20:48.777] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:5:0) after 8m12s
[09:29:00.861] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:5:0)
[09:29:00.895] Build status: STARTED
[09:29:00.895] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:6:0) after 8m14s
[09:37:15.109] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:6:0)
[09:37:15.132] Build status: STARTED
[09:37:15.132] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:7:0) after 4m0s
[09:41:15.157] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:7:0)
[09:41:15.189] Build status: STARTED
[09:41:15.190] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:8:0) after 1m12s
[09:42:27.242] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:8:0)
[09:42:27.258] Build status: STARTED
[09:42:27.258] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:9:0) after 2m34s
[09:45:01.399] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:9:0)
[09:45:01.422] Build status: STARTED
[09:45:01.422] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:10:0) after 1m28s
[09:46:29.499] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:10:0)
[09:46:29.532] Build status: STARTED
[09:46:29.532] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:11:0) after 7m10s
[09:53:39.739] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:11:0)
[09:53:39.757] Build status: STARTED
[09:53:39.757] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:12:0) after 1m42s
[09:55:21.773] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:12:0)
[09:55:21.816] Build status: STARTED
[09:55:21.816] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:13:0) after 9m21s
[10:04:42.843] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:13:0)
[10:04:42.861] Build status: STARTED
[10:04:42.861] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:14:0) after 9m46s
[10:14:28.986] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:14:0)
[10:14:29.010] Build status: STARTED
[10:14:29.010] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:15:0) after 8m42s
[10:23:11.077] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:15:0)
[10:23:11.102] Build status: STARTED
[10:23:11.102] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:16:0) after 2m31s
[10:25:42.198] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:16:0)
[10:25:42.267] Build status: STARTED
[10:25:42.267] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:17:0) after 1m41s
[10:27:23.283] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:17:0)
[10:27:23.306] Build status: STARTED
[10:27:23.306] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:18:0) after 3m34s
[10:30:57.303] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:18:0)
[10:30:57.327] Build status: STARTED
[10:30:57.327] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:19:0) after 8m35s
[10:39:32.913] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:19:0)
[10:39:32.930] Build status: STARTED
[10:39:32.930] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:20:0) after 3m47s
[10:43:19.949] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:20:0)
[10:43:19.973] Build status: STARTED
[10:43:19.973] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:21:0) after 4m20s
[10:47:40.037] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:21:0)
[10:47:40.059] Build status: STARTED
[10:47:40.059] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:22:0) after 6m44s
[10:54:24.075] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:22:0)
[10:54:24.095] Build status: STARTED
[10:54:24.095] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:23:0) after 1m48s
[10:56:12.124] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:23:0)
[10:56:12.145] Build status: STARTED
[10:56:12.145] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:24:0) after 4m43s
[11:00:55.242] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:24:0)
[11:00:55.269] Build status: STARTED
[11:00:55.269] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:25:0) after 6m5s
[11:07:00.320] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:25:0)
[11:07:00.341] Build status: STARTED
[11:07:00.341] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8847994049622648208:26:0) after 3m28s
[11:07:25.044] Received PubSub notification, asking Buildbucket for the build status
[11:07:25.062] Build:
{
"id": "8682563986974863089",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2026-05-06T09:12:27.276337625Z",
"startTime": "2026-05-06T09:12:32.641893353Z",
"endTime": "2026-05-06T11:07:24.636033762Z",
"updateTime": "2026-05-06T11:07:24.636033762Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "1c704353aa2cd398c9133fe95f3f89f2e0f06775",
"ref": "refs/heads/main"
}
}
}
[11:07:25.062] Invocation finished in 1h54m59.694790107s with status SUCCEEDED