[16:16:58.458] New invocation is queued and will start shortly
[16:16:59.589] Starting the invocation (attempt 1)
[16:16:59.619] Popped buildset tag "buildset:commit/gitiles/android.googlesource.com/platform/libcore/+/44f2039d5caa2dca3cebc5cfcc4fb39d7523140d"
[16:16:59.619] Popped gitiles commit info from properties and tags
[16:16:59.619] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[16:16:59.619] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[16:16:59.619] Buildbucket request:
{
"requestId": "8955324744349504368",
"builder": {
"project": "art",
"bucket": "ci",
"builder": "walleye-armv8-poison-ndebug"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8955324744349504368",
"job": "art/walleye-armv8-poison-ndebug",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://android.googlesource.com/platform/libcore",
"revision": "7d718fbe74ccb1cf490983fafcbf0ee30f0adc6d"
},
"id": "https://android.googlesource.com/platform/libcore/+/refs/heads/master@7d718fbe74ccb1cf490983fafcbf0ee30f0adc6d",
"title": "7d718fbe74ccb1cf490983fafcbf0ee30f0adc6d",
"url": "https://android.googlesource.com/platform/libcore/+/7d718fbe74ccb1cf490983fafcbf0ee30f0adc6d"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://android.googlesource.com/platform/libcore",
"revision": "a5324ecfd42e0a5b5073bc67b4fbb2ee8c103bb8"
},
"id": "https://android.googlesource.com/platform/libcore/+/refs/heads/master@a5324ecfd42e0a5b5073bc67b4fbb2ee8c103bb8",
"title": "a5324ecfd42e0a5b5073bc67b4fbb2ee8c103bb8",
"url": "https://android.googlesource.com/platform/libcore/+/a5324ecfd42e0a5b5073bc67b4fbb2ee8c103bb8"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://android.googlesource.com/platform/art",
"revision": "705172506b04980a89366f395f0fe832faa08c1f"
},
"id": "https://android.googlesource.com/platform/art/+/refs/heads/master@705172506b04980a89366f395f0fe832faa08c1f",
"title": "705172506b04980a89366f395f0fe832faa08c1f",
"url": "https://android.googlesource.com/platform/art/+/705172506b04980a89366f395f0fe832faa08c1f"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://android.googlesource.com/platform/art",
"revision": "6f915c7388797cdaabaf4df2bef3b66413942948"
},
"id": "https://android.googlesource.com/platform/art/+/refs/heads/master@6f915c7388797cdaabaf4df2bef3b66413942948",
"title": "6f915c7388797cdaabaf4df2bef3b66413942948",
"url": "https://android.googlesource.com/platform/art/+/6f915c7388797cdaabaf4df2bef3b66413942948"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://android.googlesource.com/platform/art",
"revision": "ea2c68d27e583cad5166fced930429f1752fc5aa"
},
"id": "https://android.googlesource.com/platform/art/+/refs/heads/master@ea2c68d27e583cad5166fced930429f1752fc5aa",
"title": "ea2c68d27e583cad5166fced930429f1752fc5aa",
"url": "https://android.googlesource.com/platform/art/+/ea2c68d27e583cad5166fced930429f1752fc5aa"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://android.googlesource.com/platform/art",
"revision": "bfb2591159eb3f48c29ddd78cc3102c89f57b442"
},
"id": "https://android.googlesource.com/platform/art/+/refs/heads/master@bfb2591159eb3f48c29ddd78cc3102c89f57b442",
"title": "bfb2591159eb3f48c29ddd78cc3102c89f57b442",
"url": "https://android.googlesource.com/platform/art/+/bfb2591159eb3f48c29ddd78cc3102c89f57b442"
},
{
"gitiles": {
"ref": "refs/heads/master",
"repo": "https://android.googlesource.com/platform/libcore",
"revision": "44f2039d5caa2dca3cebc5cfcc4fb39d7523140d"
},
"id": "https://android.googlesource.com/platform/libcore/+/refs/heads/master@44f2039d5caa2dca3cebc5cfcc4fb39d7523140d",
"title": "44f2039d5caa2dca3cebc5cfcc4fb39d7523140d",
"url": "https://android.googlesource.com/platform/libcore/+/44f2039d5caa2dca3cebc5cfcc4fb39d7523140d"
}
]
}
},
"gitilesCommit": {
"host": "android.googlesource.com",
"project": "platform/libcore",
"id": "44f2039d5caa2dca3cebc5cfcc4fb39d7523140d",
"ref": "refs/heads/master"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8955324744349504368"
},
{
"key": "scheduler_job_id",
"value": "art/walleye-armv8-poison-ndebug"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[16:17:00.055] Scheduled build:
{
"id": "8789894682332960593",
"builder": {
"project": "art",
"bucket": "ci",
"builder": "walleye-armv8-poison-ndebug"
},
"number": 3113,
"createdBy": "project:art",
"createTime": "2023-02-06T16:16:59.751575411Z",
"updateTime": "2023-02-06T16:16:59.751575411Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "android.googlesource.com",
"project": "platform/libcore",
"id": "44f2039d5caa2dca3cebc5cfcc4fb39d7523140d",
"ref": "refs/heads/master"
}
}
}
[16:17:00.055] Task URL: https://cr-buildbucket.appspot.com/build/8789894682332960593
[16:17:00.055] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:2:0) after 2m42s
[16:19:42.242] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:2:0)
[16:19:42.285] Build status: SCHEDULED
[16:19:42.285] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:3:0) after 5m50s
[16:25:07.956] Received PubSub notification, asking Buildbucket for the build status
[16:25:07.976] Build status: STARTED
[16:25:32.350] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:3:0)
[16:25:32.389] Build status: STARTED
[16:25:32.389] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:5:0) after 6m49s
[16:32:21.745] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:5:0)
[16:32:21.766] Build status: STARTED
[16:32:21.766] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:6:0) after 2m26s
[16:34:47.818] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:6:0)
[16:34:47.873] Build status: STARTED
[16:34:47.873] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:7:0) after 9m45s
[16:44:33.135] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:7:0)
[16:44:33.174] Build status: STARTED
[16:44:33.174] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:8:0) after 7m14s
[16:51:47.434] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:8:0)
[16:51:47.498] Build status: STARTED
[16:51:47.498] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:9:0) after 2m56s
[16:54:44.066] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:9:0)
[16:54:44.101] Build status: STARTED
[16:54:44.101] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:10:0) after 1m26s
[16:56:10.278] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:10:0)
[16:56:10.315] Build status: STARTED
[16:56:10.316] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:11:0) after 4m7s
[17:00:17.872] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:11:0)
[17:00:17.941] Build status: STARTED
[17:00:17.941] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:12:0) after 9m8s
[17:09:26.043] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:12:0)
[17:09:26.139] Build status: STARTED
[17:09:26.139] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:13:0) after 6m15s
[17:15:41.366] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:13:0)
[17:15:41.441] Build status: STARTED
[17:15:41.441] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:14:0) after 6m56s
[17:22:37.864] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:14:0)
[17:22:38.121] Build status: STARTED
[17:22:38.121] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:15:0) after 7m22s
[17:30:00.323] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:15:0)
[17:30:00.536] Build status: STARTED
[17:30:00.536] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:16:0) after 9m23s
[17:39:24.123] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:16:0)
[17:39:24.163] Build status: STARTED
[17:39:24.164] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:17:0) after 7m44s
[17:47:08.220] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:17:0)
[17:47:08.255] Build status: STARTED
[17:47:08.255] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:18:0) after 5m17s
[17:52:25.722] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:18:0)
[17:52:25.742] Build status: STARTED
[17:52:25.742] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:19:0) after 9m30s
[18:01:55.947] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:19:0)
[18:01:55.972] Build status: STARTED
[18:01:55.972] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:20:0) after 7m24s
[18:09:20.000] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:20:0)
[18:09:20.022] Build status: STARTED
[18:09:20.022] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:21:0) after 3m45s
[18:13:05.080] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:21:0)
[18:13:05.108] Build status: STARTED
[18:13:05.108] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:22:0) after 8m17s
[18:21:22.140] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:22:0)
[18:21:22.173] Build status: STARTED
[18:21:22.173] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:23:0) after 5m49s
[18:27:11.570] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:23:0)
[18:27:11.593] Build status: STARTED
[18:27:11.593] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:24:0) after 9m38s
[18:36:49.611] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:24:0)
[18:36:49.633] Build status: STARTED
[18:36:49.633] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:25:0) after 3m50s
[18:40:39.636] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:25:0)
[18:40:39.688] Build status: STARTED
[18:40:39.688] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:26:0) after 9m24s
[18:50:03.844] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:26:0)
[18:50:03.874] Build status: STARTED
[18:50:03.874] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:27:0) after 8m7s
[18:58:10.893] Handling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:27:0)
[18:58:10.917] Build status: STARTED
[18:58:10.917] Scheduling timer "check-buildbucket-build-status" (art/walleye-armv8-poison-ndebug:8955324744349504368:28:0) after 5m15s
[19:03:07.800] Received PubSub notification, asking Buildbucket for the build status
[19:03:07.825] Build:
{
"id": "8789894682332960593",
"builder": {
"project": "art",
"bucket": "ci",
"builder": "walleye-armv8-poison-ndebug"
},
"number": 3113,
"createdBy": "project:art",
"createTime": "2023-02-06T16:16:59.751575411Z",
"startTime": "2023-02-06T16:25:07.223512Z",
"endTime": "2023-02-06T19:03:07.515920515Z",
"updateTime": "2023-02-06T19:03:07.515920515Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "android.googlesource.com",
"project": "platform/libcore",
"id": "44f2039d5caa2dca3cebc5cfcc4fb39d7523140d",
"ref": "refs/heads/master"
}
}
}
[19:03:07.825] Invocation finished in 2h46m9.381266314s with status SUCCEEDED