[17:45:27.504] New invocation is queued and will start shortly
[17:45:29.899] Starting the invocation (attempt 1)
[17:45:29.938] Popped buildset tag "buildset:commit/gitiles/fuchsia.googlesource.com/integration/+/1d9b972810954c3f8aabc2cbfffaba459279ee20"
[17:45:29.938] Popped gitiles commit info from properties and tags
[17:45:29.939] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[17:45:29.939] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[17:45:29.939] Buildbucket request:
{
"requestId": "8832288497031235136",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "core.x64-debug-cts"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8832288497031235136",
"job": "fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "1b3adb784a85b03bac44228d5549aed020411397"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@1b3adb784a85b03bac44228d5549aed020411397",
"title": "1b3adb784a85b03bac44228d5549aed020411397",
"url": "https://fuchsia.googlesource.com/integration/+/1b3adb784a85b03bac44228d5549aed020411397"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "5624d5044076b26cfce52082dfeefb2b5e63781c"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@5624d5044076b26cfce52082dfeefb2b5e63781c",
"title": "5624d5044076b26cfce52082dfeefb2b5e63781c",
"url": "https://fuchsia.googlesource.com/integration/+/5624d5044076b26cfce52082dfeefb2b5e63781c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "1917caf9dbce5075d0fbef89e27b6ea6d24e305e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@1917caf9dbce5075d0fbef89e27b6ea6d24e305e",
"title": "1917caf9dbce5075d0fbef89e27b6ea6d24e305e",
"url": "https://fuchsia.googlesource.com/integration/+/1917caf9dbce5075d0fbef89e27b6ea6d24e305e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "eed85f866d57afd2723de6c16dbdb347ed262d43"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@eed85f866d57afd2723de6c16dbdb347ed262d43",
"title": "eed85f866d57afd2723de6c16dbdb347ed262d43",
"url": "https://fuchsia.googlesource.com/integration/+/eed85f866d57afd2723de6c16dbdb347ed262d43"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "5bad152c1d7fa2ec2d8134f6a7692dce6b0377d6"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@5bad152c1d7fa2ec2d8134f6a7692dce6b0377d6",
"title": "5bad152c1d7fa2ec2d8134f6a7692dce6b0377d6",
"url": "https://fuchsia.googlesource.com/integration/+/5bad152c1d7fa2ec2d8134f6a7692dce6b0377d6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "46845d5919816e8af1290ae7131e34dce5cfa090"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@46845d5919816e8af1290ae7131e34dce5cfa090",
"title": "46845d5919816e8af1290ae7131e34dce5cfa090",
"url": "https://fuchsia.googlesource.com/integration/+/46845d5919816e8af1290ae7131e34dce5cfa090"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "a9ac2ef50a8b04395dbc1e60a5a181c8097c1059"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@a9ac2ef50a8b04395dbc1e60a5a181c8097c1059",
"title": "a9ac2ef50a8b04395dbc1e60a5a181c8097c1059",
"url": "https://fuchsia.googlesource.com/integration/+/a9ac2ef50a8b04395dbc1e60a5a181c8097c1059"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f48d0f4d24a0973681818b067c7a787738466a2d"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f48d0f4d24a0973681818b067c7a787738466a2d",
"title": "f48d0f4d24a0973681818b067c7a787738466a2d",
"url": "https://fuchsia.googlesource.com/integration/+/f48d0f4d24a0973681818b067c7a787738466a2d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "74a69196ae235402975db5ab4baa3bbaf2600ee7"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@74a69196ae235402975db5ab4baa3bbaf2600ee7",
"title": "74a69196ae235402975db5ab4baa3bbaf2600ee7",
"url": "https://fuchsia.googlesource.com/integration/+/74a69196ae235402975db5ab4baa3bbaf2600ee7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "33854d5f599a896494fecaa185b246dc023635d2"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@33854d5f599a896494fecaa185b246dc023635d2",
"title": "33854d5f599a896494fecaa185b246dc023635d2",
"url": "https://fuchsia.googlesource.com/integration/+/33854d5f599a896494fecaa185b246dc023635d2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "0d323175b6fd9c443d6281c105138c2a0fadbec8"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@0d323175b6fd9c443d6281c105138c2a0fadbec8",
"title": "0d323175b6fd9c443d6281c105138c2a0fadbec8",
"url": "https://fuchsia.googlesource.com/integration/+/0d323175b6fd9c443d6281c105138c2a0fadbec8"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "4761de555d85e1dd9274706c2529252e2954cd07"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@4761de555d85e1dd9274706c2529252e2954cd07",
"title": "4761de555d85e1dd9274706c2529252e2954cd07",
"url": "https://fuchsia.googlesource.com/integration/+/4761de555d85e1dd9274706c2529252e2954cd07"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "e20fca61710e100682a7fccedc2975c3a98ca6a2"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@e20fca61710e100682a7fccedc2975c3a98ca6a2",
"title": "e20fca61710e100682a7fccedc2975c3a98ca6a2",
"url": "https://fuchsia.googlesource.com/integration/+/e20fca61710e100682a7fccedc2975c3a98ca6a2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "34e714295bf0c5dec91422ef1ab0df2992e30d1e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@34e714295bf0c5dec91422ef1ab0df2992e30d1e",
"title": "34e714295bf0c5dec91422ef1ab0df2992e30d1e",
"url": "https://fuchsia.googlesource.com/integration/+/34e714295bf0c5dec91422ef1ab0df2992e30d1e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "1d9b972810954c3f8aabc2cbfffaba459279ee20"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@1d9b972810954c3f8aabc2cbfffaba459279ee20",
"title": "1d9b972810954c3f8aabc2cbfffaba459279ee20",
"url": "https://fuchsia.googlesource.com/integration/+/1d9b972810954c3f8aabc2cbfffaba459279ee20"
}
]
}
},
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "1d9b972810954c3f8aabc2cbfffaba459279ee20",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8832288497031235136"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[17:45:30.432] Scheduled build:
{
"id": "8666858433711670113",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "core.x64-debug-cts"
},
"createdBy": "project:fuchsia",
"createTime": "2026-10-26T17:45:30.048639239Z",
"updateTime": "2026-10-26T17:45:30.048639239Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "1d9b972810954c3f8aabc2cbfffaba459279ee20",
"ref": "refs/heads/main"
}
}
}
[17:45:30.432] Task URL: https://cr-buildbucket.appspot.com/build/8666858433711670113
[17:45:30.432] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:2:0) after 3m52s
[17:45:31.394] Received PubSub notification, asking Buildbucket for the build status
[17:45:31.418] Build status: SCHEDULED
[17:45:39.471] Received PubSub notification, asking Buildbucket for the build status
[17:45:39.610] Build status: STARTED
[17:49:22.452] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:2:0)
[17:49:22.474] Build status: STARTED
[17:49:22.474] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:5:0) after 8m48s
[17:58:10.674] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:5:0)
[17:58:10.706] Build status: STARTED
[17:58:10.706] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:6:0) after 7m35s
[18:05:45.723] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:6:0)
[18:05:45.744] Build status: STARTED
[18:05:45.744] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:7:0) after 2m8s
[18:07:53.754] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:7:0)
[18:07:53.778] Build status: STARTED
[18:07:53.778] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:8:0) after 2m49s
[18:10:42.837] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:8:0)
[18:10:42.861] Build status: STARTED
[18:10:42.861] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:9:0) after 3m51s
[18:14:33.909] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:9:0)
[18:14:33.944] Build status: STARTED
[18:14:33.944] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:10:0) after 1m28s
[18:16:02.004] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:10:0)
[18:16:02.027] Build status: STARTED
[18:16:02.027] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:11:0) after 1m37s
[18:17:39.047] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:11:0)
[18:17:39.068] Build status: STARTED
[18:17:39.068] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:12:0) after 5m9s
[18:22:48.078] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:12:0)
[18:22:48.123] Build status: STARTED
[18:22:48.123] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:13:0) after 3m0s
[18:25:48.204] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:13:0)
[18:25:48.225] Build status: STARTED
[18:25:48.225] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:14:0) after 2m32s
[18:28:20.394] Handling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:14:0)
[18:28:20.415] Build status: STARTED
[18:28:20.415] Scheduling timer "check-buildbucket-build-status" (fuchsia/global.ci-core.x64-debug-cts-e5a0ec7f:8832288497031235136:15:0) after 4m17s
[18:29:52.460] Received PubSub notification, asking Buildbucket for the build status
[18:29:52.481] Build:
{
"id": "8666858433711670113",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "core.x64-debug-cts"
},
"createdBy": "project:fuchsia",
"createTime": "2026-10-26T17:45:30.048639239Z",
"startTime": "2026-10-26T17:45:38.881385592Z",
"endTime": "2026-10-26T18:29:51.928071486Z",
"updateTime": "2026-10-26T18:29:51.928071486Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "1d9b972810954c3f8aabc2cbfffaba459279ee20",
"ref": "refs/heads/main"
}
}
}
[18:29:52.481] Invocation finished in 44m24.982701945s with status SUCCEEDED