[21:09:36.252] New invocation is queued and will start shortly
[21:09:37.324] Starting the invocation (attempt 1)
[21:09:37.354] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/3be44e25804e776d3ff071740a60ae6d2f3ef4a7"
[21:09:37.354] Popped gitiles commit info from properties and tags
[21:09:37.354] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[21:09:37.354] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[21:09:37.355] Buildbucket request:
{
"requestId": "8874403242681705152",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8874403242681705152",
"job": "fuchsia/toolchain.ci-clang-windows-x64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "de59e7b86cd349f9f74b7561594aeae410477326"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@de59e7b86cd349f9f74b7561594aeae410477326",
"title": "de59e7b86cd349f9f74b7561594aeae410477326",
"url": "https://llvm.googlesource.com/llvm-project/+/de59e7b86cd349f9f74b7561594aeae410477326"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "6a7f572ef9758f49fcf9e178ce1cb95aa3069415"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@6a7f572ef9758f49fcf9e178ce1cb95aa3069415",
"title": "6a7f572ef9758f49fcf9e178ce1cb95aa3069415",
"url": "https://llvm.googlesource.com/llvm-project/+/6a7f572ef9758f49fcf9e178ce1cb95aa3069415"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "4dc6dfd65397e65f62a453b65cd180639c3a8b9e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@4dc6dfd65397e65f62a453b65cd180639c3a8b9e",
"title": "4dc6dfd65397e65f62a453b65cd180639c3a8b9e",
"url": "https://llvm.googlesource.com/llvm-project/+/4dc6dfd65397e65f62a453b65cd180639c3a8b9e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "b846d8c3e26ef98c8d6936e7cad354f035d322d1"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@b846d8c3e26ef98c8d6936e7cad354f035d322d1",
"title": "b846d8c3e26ef98c8d6936e7cad354f035d322d1",
"url": "https://llvm.googlesource.com/llvm-project/+/b846d8c3e26ef98c8d6936e7cad354f035d322d1"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "d64802d6d96ec5aff3739ce34f8143b935921809"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@d64802d6d96ec5aff3739ce34f8143b935921809",
"title": "d64802d6d96ec5aff3739ce34f8143b935921809",
"url": "https://llvm.googlesource.com/llvm-project/+/d64802d6d96ec5aff3739ce34f8143b935921809"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9d9662e4bdffc109cc5a7d0fa7c522d27babfa31"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9d9662e4bdffc109cc5a7d0fa7c522d27babfa31",
"title": "9d9662e4bdffc109cc5a7d0fa7c522d27babfa31",
"url": "https://llvm.googlesource.com/llvm-project/+/9d9662e4bdffc109cc5a7d0fa7c522d27babfa31"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "3c1a09d939f44cbe039ea178af5a77c40b2776a0"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@3c1a09d939f44cbe039ea178af5a77c40b2776a0",
"title": "3c1a09d939f44cbe039ea178af5a77c40b2776a0",
"url": "https://llvm.googlesource.com/llvm-project/+/3c1a09d939f44cbe039ea178af5a77c40b2776a0"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "36c78ec3c8641cb193ea66f49da01fa6f62280d7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@36c78ec3c8641cb193ea66f49da01fa6f62280d7",
"title": "36c78ec3c8641cb193ea66f49da01fa6f62280d7",
"url": "https://llvm.googlesource.com/llvm-project/+/36c78ec3c8641cb193ea66f49da01fa6f62280d7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "c98b05bd567c16d575bc241cd0602cdf6558d8db"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@c98b05bd567c16d575bc241cd0602cdf6558d8db",
"title": "c98b05bd567c16d575bc241cd0602cdf6558d8db",
"url": "https://llvm.googlesource.com/llvm-project/+/c98b05bd567c16d575bc241cd0602cdf6558d8db"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "cb6370167fd26d61397c1a2555d4c8a5f116d1f6"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@cb6370167fd26d61397c1a2555d4c8a5f116d1f6",
"title": "cb6370167fd26d61397c1a2555d4c8a5f116d1f6",
"url": "https://llvm.googlesource.com/llvm-project/+/cb6370167fd26d61397c1a2555d4c8a5f116d1f6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "c5f0c4ad378803f449f37730601b7d95059600a4"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@c5f0c4ad378803f449f37730601b7d95059600a4",
"title": "c5f0c4ad378803f449f37730601b7d95059600a4",
"url": "https://llvm.googlesource.com/llvm-project/+/c5f0c4ad378803f449f37730601b7d95059600a4"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9878ef3abd2a48fcfb81357d581dac292b52ddb3"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9878ef3abd2a48fcfb81357d581dac292b52ddb3",
"title": "9878ef3abd2a48fcfb81357d581dac292b52ddb3",
"url": "https://llvm.googlesource.com/llvm-project/+/9878ef3abd2a48fcfb81357d581dac292b52ddb3"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "97a8476068bad449c0340021398b0356a44857aa"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@97a8476068bad449c0340021398b0356a44857aa",
"title": "97a8476068bad449c0340021398b0356a44857aa",
"url": "https://llvm.googlesource.com/llvm-project/+/97a8476068bad449c0340021398b0356a44857aa"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "680b8dd7073cce6606006ae723899444521aa496"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@680b8dd7073cce6606006ae723899444521aa496",
"title": "680b8dd7073cce6606006ae723899444521aa496",
"url": "https://llvm.googlesource.com/llvm-project/+/680b8dd7073cce6606006ae723899444521aa496"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9e5b2fbe86ed9b303eff779fff012d6a96574f3d"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9e5b2fbe86ed9b303eff779fff012d6a96574f3d",
"title": "9e5b2fbe86ed9b303eff779fff012d6a96574f3d",
"url": "https://llvm.googlesource.com/llvm-project/+/9e5b2fbe86ed9b303eff779fff012d6a96574f3d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "b6ea04a37b2a41e24bb999e5a9b6a7bd2b576085"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@b6ea04a37b2a41e24bb999e5a9b6a7bd2b576085",
"title": "b6ea04a37b2a41e24bb999e5a9b6a7bd2b576085",
"url": "https://llvm.googlesource.com/llvm-project/+/b6ea04a37b2a41e24bb999e5a9b6a7bd2b576085"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "abdd4536ce0fc75c7a4ddcc1da5913ec5e028091"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@abdd4536ce0fc75c7a4ddcc1da5913ec5e028091",
"title": "abdd4536ce0fc75c7a4ddcc1da5913ec5e028091",
"url": "https://llvm.googlesource.com/llvm-project/+/abdd4536ce0fc75c7a4ddcc1da5913ec5e028091"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "695660cdfd1ca65cd6e02e6950d10c990dfa0036"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@695660cdfd1ca65cd6e02e6950d10c990dfa0036",
"title": "695660cdfd1ca65cd6e02e6950d10c990dfa0036",
"url": "https://llvm.googlesource.com/llvm-project/+/695660cdfd1ca65cd6e02e6950d10c990dfa0036"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "004c67ea257039e4e98abc26dd4ac6e8f3d7a171"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@004c67ea257039e4e98abc26dd4ac6e8f3d7a171",
"title": "004c67ea257039e4e98abc26dd4ac6e8f3d7a171",
"url": "https://llvm.googlesource.com/llvm-project/+/004c67ea257039e4e98abc26dd4ac6e8f3d7a171"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "fb5c94e712e683e8b7c3cd04b3e47584c226d751"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@fb5c94e712e683e8b7c3cd04b3e47584c226d751",
"title": "fb5c94e712e683e8b7c3cd04b3e47584c226d751",
"url": "https://llvm.googlesource.com/llvm-project/+/fb5c94e712e683e8b7c3cd04b3e47584c226d751"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "ffb453989b0e95d85b6cfa543b65fec23b65649d"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@ffb453989b0e95d85b6cfa543b65fec23b65649d",
"title": "ffb453989b0e95d85b6cfa543b65fec23b65649d",
"url": "https://llvm.googlesource.com/llvm-project/+/ffb453989b0e95d85b6cfa543b65fec23b65649d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "d46de86ca4060fe2c631c08728af7c48ce9458fd"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@d46de86ca4060fe2c631c08728af7c48ce9458fd",
"title": "d46de86ca4060fe2c631c08728af7c48ce9458fd",
"url": "https://llvm.googlesource.com/llvm-project/+/d46de86ca4060fe2c631c08728af7c48ce9458fd"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "3be44e25804e776d3ff071740a60ae6d2f3ef4a7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@3be44e25804e776d3ff071740a60ae6d2f3ef4a7",
"title": "3be44e25804e776d3ff071740a60ae6d2f3ef4a7",
"url": "https://llvm.googlesource.com/llvm-project/+/3be44e25804e776d3ff071740a60ae6d2f3ef4a7"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "3be44e25804e776d3ff071740a60ae6d2f3ef4a7",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8874403242681705152"
},
{
"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"
}
}
[21:09:37.738] Scheduled build:
{
"id": "8708973180794272369",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-07-18T21:09:37.413221204Z",
"updateTime": "2025-07-18T21:09:37.413221204Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "3be44e25804e776d3ff071740a60ae6d2f3ef4a7",
"ref": "refs/heads/main"
}
}
}
[21:09:37.739] Task URL: https://cr-buildbucket.appspot.com/build/8708973180794272369
[21:09:37.739] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:2:0) after 6m15s
[21:09:37.925] Received PubSub notification, asking Buildbucket for the build status
[21:09:38.028] Build status: SCHEDULED
[21:09:41.134] Received PubSub notification, asking Buildbucket for the build status
[21:09:41.162] Build status: STARTED
[21:15:52.803] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:2:0)
[21:15:52.891] Build status: STARTED
[21:15:52.891] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:5:0) after 6m47s
[21:22:39.926] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:5:0)
[21:22:39.947] Build status: STARTED
[21:22:39.947] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:6:0) after 6m49s
[21:29:28.965] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:6:0)
[21:29:28.994] Build status: STARTED
[21:29:28.994] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:7:0) after 6m54s
[21:36:23.014] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:7:0)
[21:36:23.054] Build status: STARTED
[21:36:23.054] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:8:0) after 3m46s
[21:40:09.159] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:8:0)
[21:40:09.190] Build status: STARTED
[21:40:09.190] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:9:0) after 9m28s
[21:49:37.365] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:9:0)
[21:49:37.388] Build status: STARTED
[21:49:37.388] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:10:0) after 5m18s
[21:54:55.414] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:10:0)
[21:54:55.440] Build status: STARTED
[21:54:55.441] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:11:0) after 1m22s
[21:56:17.463] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:11:0)
[21:56:17.498] Build status: STARTED
[21:56:17.498] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:12:0) after 2m48s
[21:59:05.528] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:12:0)
[21:59:05.604] Build status: STARTED
[21:59:05.604] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:13:0) after 2m24s
[22:01:29.676] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:13:0)
[22:01:29.699] Build status: STARTED
[22:01:29.700] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:14:0) after 7m11s
[22:08:40.884] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:14:0)
[22:08:40.904] Build status: STARTED
[22:08:40.904] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:15:0) after 6m3s
[22:14:43.929] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:15:0)
[22:14:43.989] Build status: STARTED
[22:14:43.989] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:16:0) after 2m43s
[22:17:26.974] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:16:0)
[22:17:26.992] Build status: STARTED
[22:17:26.992] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:17:0) after 1m46s
[22:19:13.075] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:17:0)
[22:19:13.094] Build status: STARTED
[22:19:13.094] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:18:0) after 8m26s
[22:27:39.132] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:18:0)
[22:27:39.147] Build status: STARTED
[22:27:39.147] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:19:0) after 1m25s
[22:29:04.186] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:19:0)
[22:29:04.213] Build status: STARTED
[22:29:04.213] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:20:0) after 8m32s
[22:37:36.343] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:20:0)
[22:37:36.365] Build status: STARTED
[22:37:36.365] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:21:0) after 5m37s
[22:43:13.398] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:21:0)
[22:43:13.414] Build status: STARTED
[22:43:13.414] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8874403242681705152:22:0) after 3m11s
[22:45:19.406] Received PubSub notification, asking Buildbucket for the build status
[22:45:19.427] Build:
{
"id": "8708973180794272369",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-07-18T21:09:37.413221204Z",
"startTime": "2025-07-18T21:09:40.926510662Z",
"endTime": "2025-07-18T22:44:47.388448132Z",
"updateTime": "2025-07-18T22:44:47.388448132Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "3be44e25804e776d3ff071740a60ae6d2f3ef4a7",
"ref": "refs/heads/main"
}
}
}
[22:45:19.427] Invocation finished in 1h35m43.197256747s with status SUCCEEDED