[16:29:10.402] New invocation is queued and will start shortly
[16:29:11.725] Starting the invocation (attempt 1)
[16:29:11.752] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/23a674d2ecc428a96d28c9772cc5178eaf763863"
[16:29:11.752] Popped gitiles commit info from properties and tags
[16:29:11.752] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[16:29:11.753] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[16:29:11.753] Buildbucket request:
{
"requestId": "8880128494734959744",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8880128494734959744",
"job": "fuchsia/prod-clang-ci-trigger-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "36290b7289adc3fe696c5e9111c91cd95ccc2772"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@36290b7289adc3fe696c5e9111c91cd95ccc2772",
"title": "36290b7289adc3fe696c5e9111c91cd95ccc2772",
"url": "https://llvm.googlesource.com/llvm-project/+/36290b7289adc3fe696c5e9111c91cd95ccc2772"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "8696d16242d220373460ab17f9fc10b2dd5d38dc"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@8696d16242d220373460ab17f9fc10b2dd5d38dc",
"title": "8696d16242d220373460ab17f9fc10b2dd5d38dc",
"url": "https://llvm.googlesource.com/llvm-project/+/8696d16242d220373460ab17f9fc10b2dd5d38dc"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "78af0f3ab8e6fcd52337b7ba5873deea5d2bfe7d"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@78af0f3ab8e6fcd52337b7ba5873deea5d2bfe7d",
"title": "78af0f3ab8e6fcd52337b7ba5873deea5d2bfe7d",
"url": "https://llvm.googlesource.com/llvm-project/+/78af0f3ab8e6fcd52337b7ba5873deea5d2bfe7d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "04fde85057cb4da2e560da629df7a52702eac489"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@04fde85057cb4da2e560da629df7a52702eac489",
"title": "04fde85057cb4da2e560da629df7a52702eac489",
"url": "https://llvm.googlesource.com/llvm-project/+/04fde85057cb4da2e560da629df7a52702eac489"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "6ebb84869e6cf1a643b053e53931c6075b2cc8ae"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@6ebb84869e6cf1a643b053e53931c6075b2cc8ae",
"title": "6ebb84869e6cf1a643b053e53931c6075b2cc8ae",
"url": "https://llvm.googlesource.com/llvm-project/+/6ebb84869e6cf1a643b053e53931c6075b2cc8ae"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "087a5d2ec7897cd99d3787820711fec76a8e1792"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@087a5d2ec7897cd99d3787820711fec76a8e1792",
"title": "087a5d2ec7897cd99d3787820711fec76a8e1792",
"url": "https://llvm.googlesource.com/llvm-project/+/087a5d2ec7897cd99d3787820711fec76a8e1792"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "63a4cae56cf896abd12ecf8dbd50f7f5fb9549e1"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@63a4cae56cf896abd12ecf8dbd50f7f5fb9549e1",
"title": "63a4cae56cf896abd12ecf8dbd50f7f5fb9549e1",
"url": "https://llvm.googlesource.com/llvm-project/+/63a4cae56cf896abd12ecf8dbd50f7f5fb9549e1"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "71d1b4c77c39201b0d533c2eccb2f5cbc1561b22"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@71d1b4c77c39201b0d533c2eccb2f5cbc1561b22",
"title": "71d1b4c77c39201b0d533c2eccb2f5cbc1561b22",
"url": "https://llvm.googlesource.com/llvm-project/+/71d1b4c77c39201b0d533c2eccb2f5cbc1561b22"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "be6c1684c058ff40b5cb29e7eb88f06f72dd50df"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@be6c1684c058ff40b5cb29e7eb88f06f72dd50df",
"title": "be6c1684c058ff40b5cb29e7eb88f06f72dd50df",
"url": "https://llvm.googlesource.com/llvm-project/+/be6c1684c058ff40b5cb29e7eb88f06f72dd50df"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "e30301aaecd24141cbdcd740aa4c16c0d9b05307"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@e30301aaecd24141cbdcd740aa4c16c0d9b05307",
"title": "e30301aaecd24141cbdcd740aa4c16c0d9b05307",
"url": "https://llvm.googlesource.com/llvm-project/+/e30301aaecd24141cbdcd740aa4c16c0d9b05307"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "82bad53bda39bd7a7bbdab81e72887dea8479a47"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@82bad53bda39bd7a7bbdab81e72887dea8479a47",
"title": "82bad53bda39bd7a7bbdab81e72887dea8479a47",
"url": "https://llvm.googlesource.com/llvm-project/+/82bad53bda39bd7a7bbdab81e72887dea8479a47"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "589e7abea570a813ef8a2e8b8f130fd40cd07141"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@589e7abea570a813ef8a2e8b8f130fd40cd07141",
"title": "589e7abea570a813ef8a2e8b8f130fd40cd07141",
"url": "https://llvm.googlesource.com/llvm-project/+/589e7abea570a813ef8a2e8b8f130fd40cd07141"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9adcb4fe125e5b2bdf894fb35c7d91e10c10e1ea"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9adcb4fe125e5b2bdf894fb35c7d91e10c10e1ea",
"title": "9adcb4fe125e5b2bdf894fb35c7d91e10c10e1ea",
"url": "https://llvm.googlesource.com/llvm-project/+/9adcb4fe125e5b2bdf894fb35c7d91e10c10e1ea"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "fa2263b3097c4e5f361505ce564a246a7f289172"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@fa2263b3097c4e5f361505ce564a246a7f289172",
"title": "fa2263b3097c4e5f361505ce564a246a7f289172",
"url": "https://llvm.googlesource.com/llvm-project/+/fa2263b3097c4e5f361505ce564a246a7f289172"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "2f5a24d0c555832ec6e5747cc7bad814ed97cbdc"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@2f5a24d0c555832ec6e5747cc7bad814ed97cbdc",
"title": "2f5a24d0c555832ec6e5747cc7bad814ed97cbdc",
"url": "https://llvm.googlesource.com/llvm-project/+/2f5a24d0c555832ec6e5747cc7bad814ed97cbdc"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "c72c0b298c13ebc4d374e84b8ea20f8ca4f5ace2"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@c72c0b298c13ebc4d374e84b8ea20f8ca4f5ace2",
"title": "c72c0b298c13ebc4d374e84b8ea20f8ca4f5ace2",
"url": "https://llvm.googlesource.com/llvm-project/+/c72c0b298c13ebc4d374e84b8ea20f8ca4f5ace2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "7fe1b43122230b556481b56210bc72466c1076d5"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@7fe1b43122230b556481b56210bc72466c1076d5",
"title": "7fe1b43122230b556481b56210bc72466c1076d5",
"url": "https://llvm.googlesource.com/llvm-project/+/7fe1b43122230b556481b56210bc72466c1076d5"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "e9c9c33fa4e26b7e18947dfefa960f68945d1899"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@e9c9c33fa4e26b7e18947dfefa960f68945d1899",
"title": "e9c9c33fa4e26b7e18947dfefa960f68945d1899",
"url": "https://llvm.googlesource.com/llvm-project/+/e9c9c33fa4e26b7e18947dfefa960f68945d1899"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "23a674d2ecc428a96d28c9772cc5178eaf763863"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@23a674d2ecc428a96d28c9772cc5178eaf763863",
"title": "23a674d2ecc428a96d28c9772cc5178eaf763863",
"url": "https://llvm.googlesource.com/llvm-project/+/23a674d2ecc428a96d28c9772cc5178eaf763863"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "23a674d2ecc428a96d28c9772cc5178eaf763863",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8880128494734959744"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/prod-clang-ci-trigger-40be1bb5"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[16:29:12.214] Scheduled build:
{
"id": "8714698432582537153",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2025-05-16T16:29:11.828758011Z",
"updateTime": "2025-05-16T16:29:11.828758011Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "23a674d2ecc428a96d28c9772cc5178eaf763863",
"ref": "refs/heads/main"
}
}
}
[16:29:12.214] Task URL: https://cr-buildbucket.appspot.com/build/8714698432582537153
[16:29:12.214] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:2:0) after 2m39s
[16:29:12.791] Received PubSub notification, asking Buildbucket for the build status
[16:29:12.817] Build status: SCHEDULED
[16:30:21.969] Received PubSub notification, asking Buildbucket for the build status
[16:30:22.001] Build status: STARTED
[16:31:51.230] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:2:0)
[16:31:51.261] Build status: STARTED
[16:31:51.261] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:5:0) after 1m57s
[16:33:48.320] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:5:0)
[16:33:48.359] Build status: STARTED
[16:33:48.359] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:6:0) after 6m10s
[16:39:58.383] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:6:0)
[16:39:58.412] Build status: STARTED
[16:39:58.412] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:7:0) after 3m6s
[16:43:04.447] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:7:0)
[16:43:04.640] Build status: STARTED
[16:43:04.640] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:8:0) after 9m9s
[16:52:13.664] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:8:0)
[16:52:13.686] Build status: STARTED
[16:52:13.686] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:9:0) after 3m16s
[16:55:29.709] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:9:0)
[16:55:29.733] Build status: STARTED
[16:55:29.733] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:10:0) after 8m32s
[17:04:01.751] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:10:0)
[17:04:01.791] Build status: STARTED
[17:04:01.791] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:11:0) after 2m32s
[17:06:33.805] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:11:0)
[17:06:33.842] Build status: STARTED
[17:06:33.842] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:12:0) after 9m2s
[17:15:35.887] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:12:0)
[17:15:35.909] Build status: STARTED
[17:15:35.909] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:13:0) after 7m32s
[17:23:07.985] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:13:0)
[17:23:08.057] Build status: STARTED
[17:23:08.057] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:14:0) after 1m20s
[17:24:28.058] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:14:0)
[17:24:28.088] Build status: STARTED
[17:24:28.088] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:15:0) after 7m23s
[17:31:51.129] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:15:0)
[17:31:51.209] Build status: STARTED
[17:31:51.209] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:16:0) after 9m34s
[17:41:25.239] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:16:0)
[17:41:25.261] Build status: STARTED
[17:41:25.261] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:17:0) after 7m39s
[17:49:04.380] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:17:0)
[17:49:04.493] Build status: STARTED
[17:49:04.493] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:18:0) after 2m50s
[17:51:54.577] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:18:0)
[17:51:54.603] Build status: STARTED
[17:51:54.603] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:19:0) after 4m28s
[17:56:22.635] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:19:0)
[17:56:22.657] Build status: STARTED
[17:56:22.657] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:20:0) after 8m6s
[18:04:28.682] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:20:0)
[18:04:28.703] Build status: STARTED
[18:04:28.703] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:21:0) after 9m27s
[18:13:55.734] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:21:0)
[18:13:55.779] Build status: STARTED
[18:13:55.780] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:22:0) after 3m40s
[18:17:35.826] Handling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:22:0)
[18:17:35.853] Build status: STARTED
[18:17:35.853] Scheduling timer "check-buildbucket-build-status" (fuchsia/prod-clang-ci-trigger-40be1bb5:8880128494734959744:23:0) after 5m58s
[18:20:15.356] Received PubSub notification, asking Buildbucket for the build status
[18:20:15.385] Build:
{
"id": "8714698432582537153",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2025-05-16T16:29:11.828758011Z",
"startTime": "2025-05-16T16:30:21.653555747Z",
"endTime": "2025-05-16T18:20:15.074283868Z",
"updateTime": "2025-05-16T18:20:15.074283868Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "23a674d2ecc428a96d28c9772cc5178eaf763863",
"ref": "refs/heads/main"
}
}
}
[18:20:15.385] Invocation finished in 1h51m4.994104243s with status SUCCEEDED