[18:41:48.118] New invocation is queued and will start shortly
[18:41:49.220] Starting the invocation (attempt 1)
[18:41:49.250] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/c44c142afc93d88f65d45dfed5fcb5faf44be558"
[18:41:49.250] Popped gitiles commit info from properties and tags
[18:41:49.250] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[18:41:49.250] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[18:41:49.251] Buildbucket request:
{
"requestId": "8875318511242206096",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8875318511242206096",
"job": "fuchsia/toolchain.ci-clang-windows-x64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "320f6820e33cef944200723e308a20438fad62ca"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@320f6820e33cef944200723e308a20438fad62ca",
"title": "320f6820e33cef944200723e308a20438fad62ca",
"url": "https://llvm.googlesource.com/llvm-project/+/320f6820e33cef944200723e308a20438fad62ca"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "b4b150f8c9a2c84a4831224b1209d1ca4824dbcb"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@b4b150f8c9a2c84a4831224b1209d1ca4824dbcb",
"title": "b4b150f8c9a2c84a4831224b1209d1ca4824dbcb",
"url": "https://llvm.googlesource.com/llvm-project/+/b4b150f8c9a2c84a4831224b1209d1ca4824dbcb"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9a8d45f6268112dce4950cd2f21628963546082f"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9a8d45f6268112dce4950cd2f21628963546082f",
"title": "9a8d45f6268112dce4950cd2f21628963546082f",
"url": "https://llvm.googlesource.com/llvm-project/+/9a8d45f6268112dce4950cd2f21628963546082f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "adaa4099d3923d4b6cb4c631f44fa347c3c6c4e1"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@adaa4099d3923d4b6cb4c631f44fa347c3c6c4e1",
"title": "adaa4099d3923d4b6cb4c631f44fa347c3c6c4e1",
"url": "https://llvm.googlesource.com/llvm-project/+/adaa4099d3923d4b6cb4c631f44fa347c3c6c4e1"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "71783fea2c1af3257d49e57ed9c5a7e543a44bbc"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@71783fea2c1af3257d49e57ed9c5a7e543a44bbc",
"title": "71783fea2c1af3257d49e57ed9c5a7e543a44bbc",
"url": "https://llvm.googlesource.com/llvm-project/+/71783fea2c1af3257d49e57ed9c5a7e543a44bbc"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "eb2b63c72218d120cf05189c9137a2eaa462e7c4"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@eb2b63c72218d120cf05189c9137a2eaa462e7c4",
"title": "eb2b63c72218d120cf05189c9137a2eaa462e7c4",
"url": "https://llvm.googlesource.com/llvm-project/+/eb2b63c72218d120cf05189c9137a2eaa462e7c4"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "e976eaf3037a1c0fe68432ae60a503bf144a1c30"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@e976eaf3037a1c0fe68432ae60a503bf144a1c30",
"title": "e976eaf3037a1c0fe68432ae60a503bf144a1c30",
"url": "https://llvm.googlesource.com/llvm-project/+/e976eaf3037a1c0fe68432ae60a503bf144a1c30"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "1e3f6a6c4fd8dafb208216ffcabe31fa978ca502"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@1e3f6a6c4fd8dafb208216ffcabe31fa978ca502",
"title": "1e3f6a6c4fd8dafb208216ffcabe31fa978ca502",
"url": "https://llvm.googlesource.com/llvm-project/+/1e3f6a6c4fd8dafb208216ffcabe31fa978ca502"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "46caad52ac14cefd6f9cf3188863818e330f3844"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@46caad52ac14cefd6f9cf3188863818e330f3844",
"title": "46caad52ac14cefd6f9cf3188863818e330f3844",
"url": "https://llvm.googlesource.com/llvm-project/+/46caad52ac14cefd6f9cf3188863818e330f3844"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "8b65c9d1ed298a9f4be675d1da9d678fd61ff2b0"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@8b65c9d1ed298a9f4be675d1da9d678fd61ff2b0",
"title": "8b65c9d1ed298a9f4be675d1da9d678fd61ff2b0",
"url": "https://llvm.googlesource.com/llvm-project/+/8b65c9d1ed298a9f4be675d1da9d678fd61ff2b0"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "2485c51715415cfbbd92a9544c4c03565bfe2788"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@2485c51715415cfbbd92a9544c4c03565bfe2788",
"title": "2485c51715415cfbbd92a9544c4c03565bfe2788",
"url": "https://llvm.googlesource.com/llvm-project/+/2485c51715415cfbbd92a9544c4c03565bfe2788"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "c44c142afc93d88f65d45dfed5fcb5faf44be558"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@c44c142afc93d88f65d45dfed5fcb5faf44be558",
"title": "c44c142afc93d88f65d45dfed5fcb5faf44be558",
"url": "https://llvm.googlesource.com/llvm-project/+/c44c142afc93d88f65d45dfed5fcb5faf44be558"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "c44c142afc93d88f65d45dfed5fcb5faf44be558",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8875318511242206096"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/toolchain.ci-clang-windows-x64-40be1bb5"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[18:41:49.671] Scheduled build:
{
"id": "8709888449345045649",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-07-08T18:41:49.304001592Z",
"updateTime": "2025-07-08T18:41:49.304001592Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "c44c142afc93d88f65d45dfed5fcb5faf44be558",
"ref": "refs/heads/main"
}
}
}
[18:41:49.671] Task URL: https://cr-buildbucket.appspot.com/build/8709888449345045649
[18:41:49.671] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:2:0) after 6m20s
[18:41:50.680] Received PubSub notification, asking Buildbucket for the build status
[18:41:50.723] Build status: SCHEDULED
[18:41:53.363] Received PubSub notification, asking Buildbucket for the build status
[18:41:53.396] Build status: STARTED
[18:48:09.746] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:2:0)
[18:48:09.805] Build status: STARTED
[18:48:09.805] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:5:0) after 4m28s
[18:52:38.051] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:5:0)
[18:52:38.080] Build status: STARTED
[18:52:38.080] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:6:0) after 8m7s
[19:00:45.105] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:6:0)
[19:00:45.143] Build status: STARTED
[19:00:45.143] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:7:0) after 3m53s
[19:04:38.120] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:7:0)
[19:04:38.151] Build status: STARTED
[19:04:38.151] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:8:0) after 1m25s
[19:06:03.216] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:8:0)
[19:06:03.242] Build status: STARTED
[19:06:03.242] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:9:0) after 3m29s
[19:09:32.274] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:9:0)
[19:09:32.332] Build status: STARTED
[19:09:32.332] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:10:0) after 1m56s
[19:11:28.360] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:10:0)
[19:11:28.396] Build status: STARTED
[19:11:28.396] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:11:0) after 7m9s
[19:18:37.538] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:11:0)
[19:18:37.567] Build status: STARTED
[19:18:37.567] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:12:0) after 6m7s
[19:24:44.608] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:12:0)
[19:24:44.677] Build status: STARTED
[19:24:44.677] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:13:0) after 4m38s
[19:29:22.766] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:13:0)
[19:29:22.788] Build status: STARTED
[19:29:22.788] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:14:0) after 5m12s
[19:34:34.874] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:14:0)
[19:34:34.944] Build status: STARTED
[19:34:34.944] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:15:0) after 2m15s
[19:36:50.018] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:15:0)
[19:36:50.062] Build status: STARTED
[19:36:50.062] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:16:0) after 8m10s
[19:45:00.196] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:16:0)
[19:45:00.257] Build status: STARTED
[19:45:00.257] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:17:0) after 7m48s
[19:52:48.323] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:17:0)
[19:52:48.339] Build status: STARTED
[19:52:48.339] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:18:0) after 4m49s
[19:57:37.436] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:18:0)
[19:57:37.460] Build status: STARTED
[19:57:37.460] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:19:0) after 1m45s
[19:59:22.435] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:19:0)
[19:59:22.454] Build status: STARTED
[19:59:22.454] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:20:0) after 8m25s
[20:07:47.473] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:20:0)
[20:07:47.490] Build status: STARTED
[20:07:47.490] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8875318511242206096:21:0) after 9m49s
[20:14:56.858] Received PubSub notification, asking Buildbucket for the build status
[20:14:56.910] Build:
{
"id": "8709888449345045649",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-07-08T18:41:49.304001592Z",
"startTime": "2025-07-08T18:41:52.971553888Z",
"endTime": "2025-07-08T20:14:56.355511393Z",
"updateTime": "2025-07-08T20:14:56.355511393Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "c44c142afc93d88f65d45dfed5fcb5faf44be558",
"ref": "refs/heads/main"
}
}
}
[20:14:56.910] Invocation finished in 1h33m8.79823645s with status SUCCEEDED