[101.270314] Initializing watchdogs
[101.270840]   /dev/watchdog0
[101.437603] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:46d3 Intel Alderlake_n (Gen12) 
[101.482649] [001/162] (960s left) i915_module_load (load)
[102.658188] Starting subtest: load
[113.640362] Subtest load: SUCCESS (10.977s)
[113.970511] [FACT i915_module_load (load)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[113.987150] [FACT i915_module_load (load)] new: kernel.kmod_is_loaded.i915: true
[114.037484] [002/162] (948s left) core_auth (basic-auth)
[114.624946] Starting subtest: basic-auth
[114.638123] Subtest basic-auth: SUCCESS (0.013s)
[115.170314] [003/162] (947s left) debugfs_test (read_all_entries)
[115.606907] Starting subtest: read_all_entries
[117.080825] Subtest read_all_entries: SUCCESS (1.472s)
[117.602789] [004/162] (945s left) debugfs_test (basic-hwmon)
[118.013411] Starting subtest: basic-hwmon
[118.019500] Subtest basic-hwmon: SKIP (0.000s)
[118.554414] [005/162] (944s left) debugfs_test (sysfs)
[118.970468] Starting subtest: sysfs
[119.435694] Subtest sysfs: SUCCESS (0.465s)
[119.949684] [006/162] (943s left) fbdev (eof)
[120.342937] Starting subtest: eof
[120.345866] Subtest eof: SUCCESS (0.004s)
[120.778630] [007/162] (943s left) fbdev (info)
[121.163761] Starting subtest: info
[121.167176] Subtest info: SUCCESS (0.000s)
[121.612606] [008/162] (942s left) fbdev (nullptr)
[121.998876] Starting subtest: nullptr
[122.002130] Subtest nullptr: SUCCESS (0.001s)
[122.436869] [009/162] (942s left) fbdev (read)
[122.816772] Starting subtest: read
[136.487788] Subtest read: SUCCESS (13.640s)
[136.902288] [010/162] (928s left) fbdev (write)
[137.280415] Starting subtest: write
[144.404347] Subtest write: SUCCESS (7.118s)
[144.858761] [011/162] (920s left) gem_basic (bad-close)
[145.237473] Starting subtest: bad-close
[145.243892] Subtest bad-close: SUCCESS (0.000s)
[145.655270] [012/162] (920s left) gem_basic (create-close)
[146.026558] Starting subtest: create-close
[146.032182] Subtest create-close: SUCCESS (0.001s)
[146.452368] [013/162] (919s left) gem_basic (create-fd-close)
[146.830727] Starting subtest: create-fd-close
[146.836431] Subtest create-fd-close: SUCCESS (0.001s)
[147.268532] [014/162] (919s left) gem_busy (busy@all-engines)
[147.740751] Starting subtest: busy
[147.743863] Starting dynamic subtest: all-engines
[148.054949] Dynamic subtest all-engines: SUCCESS (0.317s)
[148.058220] Subtest busy: SUCCESS (0.319s)
[148.918833] [015/162] (917s left) gem_close_race (basic-process)
[149.398344] Starting subtest: basic-process
[149.539857] Subtest basic-process: SUCCESS (0.141s)
[150.092706] [016/162] (917s left) gem_close_race (basic-threads)
[150.577875] Starting subtest: basic-threads
[152.281091] Subtest basic-threads: SUCCESS (1.698s)
[152.815444] [017/162] (914s left) gem_ctx_create (basic)
[153.280303] Starting subtest: basic
[153.282977] Subtest basic: SUCCESS (0.000s)
[153.827815] [018/162] (913s left) gem_ctx_create (basic-files)
[154.294332] Starting subtest: basic-files
[156.401841] Subtest basic-files: SUCCESS (2.110s)
[157.038494] [019/162] (911s left) gem_ctx_exec (basic)
[157.427823] Starting subtest: basic
[157.448951] Subtest basic: SUCCESS (0.022s)
[157.916243] [020/162] (910s left) gem_exec_basic (basic)
[158.353220] Starting subtest: basic
[158.356285] Starting dynamic subtest: rcs0-smem
[158.363194] Dynamic subtest rcs0-smem: SUCCESS (0.008s)
[158.421884] Starting dynamic subtest: bcs0-smem
[158.424854] Dynamic subtest bcs0-smem: SUCCESS (0.004s)
[158.481979] Starting dynamic subtest: vcs0-smem
[158.485062] Dynamic subtest vcs0-smem: SUCCESS (0.004s)
[158.545619] Starting dynamic subtest: vecs0-smem
[158.549335] Dynamic subtest vecs0-smem: SUCCESS (0.004s)
[158.552526] Subtest basic: SUCCESS (0.029s)
[158.942458] [021/162] (909s left) gem_exec_create (basic)
[159.404076] Starting subtest: basic
[159.407204] Starting dynamic subtest: smem
[161.620958] Dynamic subtest smem: SUCCESS (2.216s)
[161.624195] Subtest basic: SUCCESS (2.219s)
[162.182732] [022/162] (906s left) gem_exec_fence (basic-busy)
[162.841211] Starting subtest: basic-busy
[162.844514] Starting dynamic subtest: rcs0
[162.966807] Dynamic subtest rcs0: SUCCESS (0.125s)
[163.029846] Starting dynamic subtest: bcs0
[163.036326] Dynamic subtest bcs0: SUCCESS (0.062s)
[163.097185] Starting dynamic subtest: vcs0
[163.102387] Dynamic subtest vcs0: SUCCESS (0.059s)
[163.161142] Starting dynamic subtest: vecs0
[163.168732] Dynamic subtest vecs0: SUCCESS (0.067s)
[163.171811] Subtest basic-busy: SUCCESS (0.321s)
[164.629698] [FACT gem_exec_fence (basic-busy)] new: kernel.kmod_is_loaded.vgem: true
[164.652317] [023/162] (904s left) gem_exec_fence (basic-wait)
[165.313900] Starting subtest: basic-wait
[165.317206] Starting dynamic subtest: rcs0
[165.396211] Dynamic subtest rcs0: SUCCESS (0.081s)
[165.462128] Starting dynamic subtest: bcs0
[165.465464] Dynamic subtest bcs0: SUCCESS (0.065s)
[165.529449] Starting dynamic subtest: vcs0
[165.534859] Dynamic subtest vcs0: SUCCESS (0.059s)
[165.598477] Starting dynamic subtest: vecs0
[165.604868] Dynamic subtest vecs0: SUCCESS (0.062s)
[165.608103] Subtest basic-wait: SUCCESS (0.274s)
[166.900416] [024/162] (902s left) gem_exec_fence (basic-await)
[167.560231] Starting subtest: basic-await
[167.563417] Starting dynamic subtest: rcs0
[167.897316] Dynamic subtest rcs0: SUCCESS (0.333s)
[167.958640] Starting dynamic subtest: bcs0
[168.202562] Dynamic subtest bcs0: SUCCESS (0.306s)
[168.273264] Starting dynamic subtest: vcs0
[168.506095] Dynamic subtest vcs0: SUCCESS (0.300s)
[168.568336] Starting dynamic subtest: vecs0
[168.808451] Dynamic subtest vecs0: SUCCESS (0.303s)
[168.812075] Subtest basic-await: SUCCESS (1.249s)
[170.108446] [025/162] (900s left) gem_exec_fence (nb-await)
[170.775571] Starting subtest: nb-await
[170.778775] Starting dynamic subtest: rcs0
[170.890080] Dynamic subtest rcs0: SUCCESS (0.116s)
[170.955755] Starting dynamic subtest: bcs0
[170.979103] Dynamic subtest bcs0: SUCCESS (0.087s)
[171.040709] Starting dynamic subtest: vcs0
[171.069855] Dynamic subtest vcs0: SUCCESS (0.088s)
[171.133787] Starting dynamic subtest: vecs0
[171.158644] Dynamic subtest vecs0: SUCCESS (0.087s)
[171.161613] Subtest nb-await: SUCCESS (0.387s)
[172.417418] [026/162] (898s left) gem_exec_gttfill (basic)
[172.884275] Starting subtest: basic
[211.200207] Subtest basic: SUCCESS (38.307s)
[211.898481] [027/162] (859s left) gem_exec_parallel (engines)
[212.485134] Starting subtest: engines
[212.488095] Starting dynamic subtest: basic
[219.126789] Dynamic subtest basic: SUCCESS (6.645s)
[219.193138] Starting dynamic subtest: contexts
[230.214434] Dynamic subtest contexts: SUCCESS (11.078s)
[230.282912] Starting dynamic subtest: fds
[244.336995] Dynamic subtest fds: SUCCESS (14.120s)
[244.410782] Starting dynamic subtest: userptr
[250.021340] Dynamic subtest userptr: SUCCESS (5.693s)
[250.024658] Subtest engines: SUCCESS (37.542s)
[250.647411] [028/162] (820s left) gem_exec_store (basic)
[251.117448] Starting subtest: basic
[251.249826] Subtest basic: SUCCESS (0.136s)
[251.839550] [029/162] (819s left) gem_flink_basic (bad-flink)
[252.207231] Starting subtest: bad-flink
[252.210834] Subtest bad-flink: SUCCESS (0.000s)
[252.654553] [030/162] (819s left) gem_flink_basic (bad-open)
[253.026047] Starting subtest: bad-open
[253.029276] Subtest bad-open: SUCCESS (0.000s)
[253.479688] [031/162] (818s left) gem_flink_basic (basic)
[253.852602] Starting subtest: basic
[253.855743] Subtest basic: SUCCESS (0.001s)
[254.328857] [032/162] (818s left) gem_flink_basic (double-flink)
[254.698980] Starting subtest: double-flink
[254.702348] Subtest double-flink: SUCCESS (0.000s)
[255.160741] [033/162] (818s left) gem_flink_basic (flink-lifetime)
[255.535341] Starting subtest: flink-lifetime
[255.550286] Subtest flink-lifetime: SUCCESS (0.010s)
[256.036712] [034/162] (817s left) gem_huc_copy (huc-copy)
[256.449658] Starting subtest: huc-copy
[256.470746] Subtest huc-copy: SUCCESS (0.020s)
[256.971947] [035/162] (816s left) gem_linear_blits (basic)
[258.063653] Starting subtest: basic
[258.108598] Subtest basic: SUCCESS (0.057s)
[258.696480] [036/162] (815s left) gem_mmap (basic)
[259.266039] Starting subtest: basic
[259.279990] Subtest basic: SUCCESS (0.003s)
[259.730217] [037/162] (815s left) gem_mmap_gtt (basic)
[260.102783] Starting subtest: basic
[260.109648] Subtest basic: SUCCESS (0.005s)
[260.571525] [038/162] (814s left) gem_render_linear_blits (basic)
[260.984259] Starting subtest: basic
[261.187427] Subtest basic: SUCCESS (0.205s)
[261.653759] [039/162] (813s left) gem_render_tiled_blits (basic)
[262.057126] Starting subtest: basic
[262.343108] Subtest basic: SUCCESS (0.285s)
[262.802872] [040/162] (813s left) gem_ringfill (basic-all)
[263.683427] Starting subtest: basic-all
[265.123441] Subtest basic-all: SUCCESS (1.433s)
[265.575367] [041/162] (810s left) gem_softpin (allocator-basic)
[265.991096] Starting subtest: allocator-basic
[266.677531] Subtest allocator-basic: SUCCESS (0.681s)
[267.236212] [042/162] (809s left) gem_softpin (allocator-basic-reserve)
[267.638280] Starting subtest: allocator-basic-reserve
[268.323738] Subtest allocator-basic-reserve: SUCCESS (0.679s)
[268.876820] [043/162] (808s left) gem_softpin (safe-alignment)
[269.294208] Starting subtest: safe-alignment
[269.376463] Subtest safe-alignment: SUCCESS (0.081s)
[269.879713] [044/162] (807s left) gem_sync (basic-all)
[270.348926] Starting subtest: basic-all
[275.562708] Subtest basic-all: SUCCESS (5.217s)
[276.154507] [045/162] (801s left) gem_sync (basic-each)
[276.620238] Starting subtest: basic-each
[280.197319] Subtest basic-each: SUCCESS (3.577s)
[280.790866] [046/162] (797s left) gem_tiled_blits (basic)
[281.719323] Starting subtest: basic
[281.821290] Subtest basic: SUCCESS (0.113s)
[282.353444] [047/162] (796s left) gem_tiled_fence_blits (basic)
[283.500102] Starting subtest: basic
[283.568085] Subtest basic: SUCCESS (0.077s)
[284.137922] [048/162] (794s left) gem_tiled_pread_basic
[285.196316] [049/162] (794s left) gem_wait (busy@all-engines)
[285.922951] Starting subtest: busy
[285.939134] Starting dynamic subtest: all-engines
[286.519225] Dynamic subtest all-engines: SUCCESS (0.607s)
[286.522349] Subtest busy: SUCCESS (0.609s)
[287.244990] [050/162] (792s left) gem_wait (wait@all-engines)
[287.764451] Starting subtest: wait
[287.767666] Starting dynamic subtest: all-engines
[288.862431] Dynamic subtest all-engines: SUCCESS (1.105s)
[288.865778] Subtest wait: SUCCESS (1.107s)
[289.583304] [051/162] (790s left) i915_pm_rc6_residency (rc6-idle)
[289.964515] Starting subtest: rc6-idle
[290.002214] Starting dynamic subtest: gt0-rcs0
[314.621940] Dynamic subtest gt0-rcs0: SUCCESS (24.611s)
[314.698212] Starting dynamic subtest: gt0-bcs0
[339.137145] Dynamic subtest gt0-bcs0: SUCCESS (24.518s)
[339.220204] Starting dynamic subtest: gt0-vcs0
[363.925053] Dynamic subtest gt0-vcs0: SUCCESS (24.775s)
[363.996327] Starting dynamic subtest: gt0-vecs0
[388.603246] Dynamic subtest gt0-vecs0: SUCCESS (24.675s)
[388.606527] Subtest rc6-idle: SUCCESS (98.626s)
[389.060421] [052/162] (691s left) i915_getparams_basic (basic-eu-total)
[389.427565] Starting subtest: basic-eu-total
[389.433567] Subtest basic-eu-total: SUCCESS (0.000s)
[389.890310] [053/162] (690s left) i915_getparams_basic (basic-subslice-total)
[390.264889] Starting subtest: basic-subslice-total
[390.271113] Subtest basic-subslice-total: SUCCESS (0.000s)
[390.742584] [054/162] (690s left) i915_hangman (error-state-basic)
[391.208836] Starting subtest: error-state-basic
[392.346355] Subtest error-state-basic: SUCCESS (1.135s)
[392.853572] [055/162] (688s left) i915_pciid
[393.694612] [056/162] (688s left) kms_addfb_basic (addfb25-4-tiled)
[394.210871] Starting subtest: addfb25-4-tiled
[394.214483] Subtest addfb25-4-tiled: SUCCESS (0.003s)
[394.691829] [057/162] (687s left) kms_addfb_basic (addfb25-bad-modifier)
[395.173739] Starting subtest: addfb25-bad-modifier
[395.176859] Subtest addfb25-bad-modifier: SUCCESS (0.002s)
[395.648492] [058/162] (687s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[396.132354] Starting subtest: addfb25-framebuffer-vs-set-tiling
[396.135053] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.002s)
[396.621402] [059/162] (686s left) kms_addfb_basic (addfb25-modifier-no-flag)
[397.103933] Starting subtest: addfb25-modifier-no-flag
[397.107110] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[397.581418] [060/162] (685s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[398.067920] Starting subtest: addfb25-x-tiled-legacy
[398.070970] Subtest addfb25-x-tiled-legacy: SUCCESS (0.001s)
[398.546708] [061/162] (685s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[399.029861] Starting subtest: addfb25-x-tiled-mismatch-legacy
[399.032821] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.002s)
[399.500154] [062/162] (684s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[399.982257] Starting subtest: addfb25-yf-tiled-legacy
[399.985449] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.002s)
[400.462780] [063/162] (684s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[400.943496] Starting subtest: addfb25-y-tiled-legacy
[400.946472] Subtest addfb25-y-tiled-legacy: SUCCESS (0.001s)
[401.422838] [064/162] (683s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[401.908603] Starting subtest: addfb25-y-tiled-small-legacy
[401.912364] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.002s)
[402.393680] [065/162] (682s left) kms_addfb_basic (bad-pitch-0)
[402.769928] Starting subtest: bad-pitch-0
[402.773596] Subtest bad-pitch-0: SUCCESS (0.000s)
[403.342745] [066/162] (682s left) kms_addfb_basic (bad-pitch-1024)
[403.719779] Starting subtest: bad-pitch-1024
[403.723401] Subtest bad-pitch-1024: SUCCESS (0.000s)
[404.315564] [067/162] (681s left) kms_addfb_basic (bad-pitch-128)
[404.693669] Starting subtest: bad-pitch-128
[404.696637] Subtest bad-pitch-128: SUCCESS (0.000s)
[405.270138] [068/162] (681s left) kms_addfb_basic (bad-pitch-256)
[405.660353] Starting subtest: bad-pitch-256
[405.663323] Subtest bad-pitch-256: SUCCESS (0.000s)
[406.273512] [069/162] (680s left) kms_addfb_basic (bad-pitch-32)
[406.649816] Starting subtest: bad-pitch-32
[406.652667] Subtest bad-pitch-32: SUCCESS (0.000s)
[407.235599] [070/162] (680s left) kms_addfb_basic (bad-pitch-63)
[407.611680] Starting subtest: bad-pitch-63
[407.615144] Subtest bad-pitch-63: SUCCESS (0.000s)
[408.201395] [071/162] (679s left) kms_addfb_basic (bad-pitch-65536)
[408.585900] Starting subtest: bad-pitch-65536
[408.589255] Subtest bad-pitch-65536: SUCCESS (0.002s)
[409.161630] [072/162] (678s left) kms_addfb_basic (bad-pitch-999)
[409.542651] Starting subtest: bad-pitch-999
[409.545985] Subtest bad-pitch-999: SUCCESS (0.000s)
[410.122512] [073/162] (678s left) kms_addfb_basic (basic)
[410.498641] Starting subtest: basic
[410.501667] Subtest basic: SUCCESS (0.000s)
[411.078464] [074/162] (677s left) kms_addfb_basic (basic-x-tiled-legacy)
[411.459643] Starting subtest: basic-x-tiled-legacy
[411.462980] Subtest basic-x-tiled-legacy: SUCCESS (0.001s)
[412.048453] [075/162] (677s left) kms_addfb_basic (basic-y-tiled-legacy)
[412.430894] Starting subtest: basic-y-tiled-legacy
[412.433773] Subtest basic-y-tiled-legacy: SUCCESS (0.002s)
[413.005720] [076/162] (676s left) kms_addfb_basic (bo-too-small)
[413.488655] Starting subtest: bo-too-small
[413.492365] Subtest bo-too-small: SUCCESS (0.002s)
[413.973041] [077/162] (676s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[414.456215] Starting subtest: bo-too-small-due-to-tiling
[414.459270] Subtest bo-too-small-due-to-tiling: SUCCESS (0.002s)
[414.935932] [078/162] (675s left) kms_addfb_basic (clobberred-modifier)
[415.314566] Starting subtest: clobberred-modifier
[415.317458] Subtest clobberred-modifier: SUCCESS (0.001s)
[415.897461] [079/162] (674s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[416.276676] Starting subtest: framebuffer-vs-set-tiling
[416.279788] Subtest framebuffer-vs-set-tiling: SUCCESS (0.001s)
[416.866980] [080/162] (674s left) kms_addfb_basic (invalid-get-prop)
[417.246948] Starting subtest: invalid-get-prop
[417.250364] Subtest invalid-get-prop: SUCCESS (0.000s)
[417.830337] [081/162] (673s left) kms_addfb_basic (invalid-get-prop-any)
[418.206769] Starting subtest: invalid-get-prop-any
[418.210127] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[418.776485] [082/162] (673s left) kms_addfb_basic (invalid-set-prop)
[419.148127] Starting subtest: invalid-set-prop
[419.151464] Subtest invalid-set-prop: SUCCESS (0.000s)
[419.736464] [083/162] (672s left) kms_addfb_basic (invalid-set-prop-any)
[420.113524] Starting subtest: invalid-set-prop-any
[420.116944] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[420.698876] [084/162] (671s left) kms_addfb_basic (no-handle)
[421.096338] Starting subtest: no-handle
[421.098994] Subtest no-handle: SUCCESS (0.000s)
[421.670910] [085/162] (671s left) kms_addfb_basic (size-max)
[422.153245] Starting subtest: size-max
[422.156285] Subtest size-max: SUCCESS (0.001s)
[422.646524] [086/162] (670s left) kms_addfb_basic (small-bo)
[423.127669] Starting subtest: small-bo
[423.130616] Subtest small-bo: SUCCESS (0.000s)
[423.627400] [087/162] (670s left) kms_addfb_basic (tile-pitch-mismatch)
[424.008938] Starting subtest: tile-pitch-mismatch
[424.011917] Subtest tile-pitch-mismatch: SUCCESS (0.002s)
[424.596415] [088/162] (669s left) kms_addfb_basic (too-high)
[425.074216] Starting subtest: too-high
[425.082931] Subtest too-high: SUCCESS (0.006s)
[425.563905] [089/162] (669s left) kms_addfb_basic (too-wide)
[426.046832] Starting subtest: too-wide
[426.050382] Subtest too-wide: SUCCESS (0.000s)
[426.519659] [090/162] (668s left) kms_addfb_basic (unused-handle)
[426.897088] Starting subtest: unused-handle
[426.900321] Subtest unused-handle: SUCCESS (0.000s)
[427.483376] [091/162] (667s left) kms_addfb_basic (unused-modifier)
[427.861594] Starting subtest: unused-modifier
[427.865423] Subtest unused-modifier: SUCCESS (0.000s)
[428.443428] [092/162] (667s left) kms_addfb_basic (unused-offsets)
[428.819650] Starting subtest: unused-offsets
[428.823206] Subtest unused-offsets: SUCCESS (0.000s)
[429.413167] [093/162] (666s left) kms_addfb_basic (unused-pitches)
[429.794936] Starting subtest: unused-pitches
[429.798312] Subtest unused-pitches: SUCCESS (0.000s)
[430.368900] [094/162] (666s left) kms_busy (basic)
[430.882397] Starting subtest: basic
[430.892433] Starting dynamic subtest: flip
[433.186668] Dynamic subtest flip: SUCCESS (2.291s)
[433.272284] Starting dynamic subtest: modeset
[438.500220] Dynamic subtest modeset: SUCCESS (5.315s)
[438.502833] Subtest basic: SUCCESS (7.617s)
[439.832882] [095/162] (657s left) kms_prop_blob (basic)
[440.205617] Starting subtest: basic
[440.208578] Subtest basic: SUCCESS (0.000s)
[440.665581] [096/162] (656s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[441.293909] Starting subtest: basic-busy-flip-before-cursor-atomic
[441.299416] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[441.888945] [097/162] (655s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[442.502535] Starting subtest: basic-busy-flip-before-cursor-legacy
[442.508202] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s)
[443.096952] [098/162] (654s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[443.710348] Starting subtest: basic-flip-after-cursor-atomic
[446.105258] Subtest basic-flip-after-cursor-atomic: SUCCESS (2.384s)
[447.155851] [099/162] (651s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[447.777795] Starting subtest: basic-flip-after-cursor-legacy
[449.387970] Subtest basic-flip-after-cursor-legacy: SUCCESS (1.606s)
[450.688549] [100/162] (648s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[451.322123] Starting subtest: basic-flip-after-cursor-varying-size
[452.932170] Subtest basic-flip-after-cursor-varying-size: SUCCESS (1.608s)
[454.211557] [101/162] (645s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[454.832111] Starting subtest: basic-flip-before-cursor-atomic
[456.437804] Subtest basic-flip-before-cursor-atomic: SUCCESS (1.604s)
[457.739229] [102/162] (641s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[458.360395] Starting subtest: basic-flip-before-cursor-legacy
[459.966217] Subtest basic-flip-before-cursor-legacy: SUCCESS (1.606s)
[461.268615] [103/162] (638s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[461.888759] Starting subtest: basic-flip-before-cursor-varying-size
[464.291261] Subtest basic-flip-before-cursor-varying-size: SUCCESS (2.393s)
[465.287502] [104/162] (635s left) kms_dsc (dsc-basic)
[465.804969] Starting subtest: dsc-basic
[465.821555] Subtest dsc-basic: SKIP (0.003s)
[466.278404] [105/162] (634s left) kms_flip (basic-flip-vs-dpms)
[466.759502] Starting subtest: basic-flip-vs-dpms
[466.768966] Starting dynamic subtest: A-eDP1
[470.620320] Dynamic subtest A-eDP1: SUCCESS (3.850s)
[470.706751] Starting dynamic subtest: B-eDP1
[473.887745] Dynamic subtest B-eDP1: SUCCESS (3.261s)
[473.978634] Starting dynamic subtest: C-eDP1
[477.732772] Dynamic subtest C-eDP1: SUCCESS (3.839s)
[477.739761] Subtest basic-flip-vs-dpms: SUCCESS (10.983s)
[479.018758] [106/162] (622s left) kms_flip (basic-flip-vs-modeset)
[479.501380] Starting subtest: basic-flip-vs-modeset
[479.511302] Starting dynamic subtest: A-eDP1
[483.330681] Dynamic subtest A-eDP1: SUCCESS (3.817s)
[483.415511] Starting dynamic subtest: B-eDP1
[486.468709] Dynamic subtest B-eDP1: SUCCESS (3.131s)
[486.555722] Starting dynamic subtest: C-eDP1
[490.002598] Dynamic subtest C-eDP1: SUCCESS (3.527s)
[490.009513] Subtest basic-flip-vs-modeset: SUCCESS (10.511s)
[491.295399] [107/162] (610s left) kms_flip (basic-flip-vs-wf_vblank)
[491.786716] Starting subtest: basic-flip-vs-wf_vblank
[491.797641] Starting dynamic subtest: A-eDP1
[494.872470] Dynamic subtest A-eDP1: SUCCESS (3.075s)
[494.962231] Starting dynamic subtest: B-eDP1
[498.384546] Dynamic subtest B-eDP1: SUCCESS (3.505s)
[498.481946] Starting dynamic subtest: C-eDP1
[501.276768] Dynamic subtest C-eDP1: SUCCESS (2.886s)
[501.286677] Subtest basic-flip-vs-wf_vblank: SUCCESS (9.503s)
[503.322837] [108/162] (598s left) kms_flip (basic-plain-flip)
[503.809471] Starting subtest: basic-plain-flip
[503.822966] Starting dynamic subtest: A-eDP1
[506.596985] Dynamic subtest A-eDP1: SUCCESS (2.773s)
[506.686606] Starting dynamic subtest: B-eDP1
[509.420819] Dynamic subtest B-eDP1: SUCCESS (2.817s)
[509.518886] Starting dynamic subtest: C-eDP1
[512.076965] Dynamic subtest C-eDP1: SUCCESS (2.650s)
[512.087152] Subtest basic-plain-flip: SUCCESS (8.278s)
[514.293854] [109/162] (588s left) kms_force_connector_basic (force-connector-state)
[514.702458] Starting subtest: force-connector-state
[515.539647] Subtest force-connector-state: SUCCESS (0.836s)
[517.225129] [110/162] (585s left) kms_force_connector_basic (force-edid)
[517.635614] Starting subtest: force-edid
[517.737698] Subtest force-edid: SUCCESS (0.106s)
[518.393955] [111/162] (584s left) kms_force_connector_basic (force-load-detect)
[518.801465] Starting subtest: force-load-detect
[518.807673] Subtest force-load-detect: SKIP (0.000s)
[519.401140] [112/162] (584s left) kms_force_connector_basic (prune-stale-modes)
[519.805082] Starting subtest: prune-stale-modes
[519.927946] Subtest prune-stale-modes: SUCCESS (0.126s)
[520.579258] [113/162] (583s left) kms_frontbuffer_tracking (basic)
[521.103696] Starting subtest: basic
[548.443782] Subtest basic: SUCCESS (27.345s)
[549.054185] [114/162] (555s left) kms_hdmi_inject (inject-audio)
[550.721772] Starting subtest: inject-audio
[551.256063] Subtest inject-audio: SUCCESS (0.531s)
[552.359966] [115/162] (552s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[552.844690] Starting subtest: compare-crc-sanitycheck-xr24
[552.853859] Starting dynamic subtest: pipe-A-eDP-1
[554.621188] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.764s)
[554.721710] Starting dynamic subtest: pipe-B-eDP-1
[557.616132] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.984s)
[557.712793] Starting dynamic subtest: pipe-C-eDP-1
[559.776897] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.141s)
[559.779622] Subtest compare-crc-sanitycheck-xr24: SUCCESS (6.930s)
[561.007219] [116/162] (544s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[561.497517] Starting subtest: compare-crc-sanitycheck-nv12
[561.502658] Starting dynamic subtest: pipe-A-eDP-1
[564.447736] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.939s)
[564.547724] Starting dynamic subtest: pipe-B-eDP-1
[567.864678] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.408s)
[567.963244] Starting dynamic subtest: pipe-C-eDP-1
[571.146262] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.265s)
[571.149052] Subtest compare-crc-sanitycheck-nv12: SUCCESS (9.654s)
[572.417906] [117/162] (533s left) kms_pipe_crc_basic (hang-read-crc)
[572.902610] Starting subtest: hang-read-crc
[572.913313] Starting dynamic subtest: pipe-A-eDP-1
[578.323643] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.407s)
[578.419155] Starting dynamic subtest: pipe-B-eDP-1
[584.216547] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.879s)
[584.314284] Starting dynamic subtest: pipe-C-eDP-1
[589.899556] Dynamic subtest pipe-C-eDP-1: SUCCESS (5.663s)
[589.902506] Subtest hang-read-crc: SUCCESS (16.994s)
[591.152692] [118/162] (514s left) kms_pipe_crc_basic (nonblocking-crc)
[591.648909] Starting subtest: nonblocking-crc
[591.654117] Starting dynamic subtest: pipe-A-eDP-1
[593.728691] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.069s)
[593.832134] Starting dynamic subtest: pipe-B-eDP-1
[596.213911] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.470s)
[596.316133] Starting dynamic subtest: pipe-C-eDP-1
[598.617329] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.387s)
[598.620697] Subtest nonblocking-crc: SUCCESS (6.974s)
[599.918730] [119/162] (506s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[600.411664] Starting subtest: nonblocking-crc-frame-sequence
[600.429098] Starting dynamic subtest: pipe-A-eDP-1
[602.485278] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.060s)
[602.583109] Starting dynamic subtest: pipe-B-eDP-1
[604.973350] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.470s)
[605.084156] Starting dynamic subtest: pipe-C-eDP-1
[608.202238] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.214s)
[608.205868] Subtest nonblocking-crc-frame-sequence: SUCCESS (7.793s)
[609.194230] [120/162] (497s left) kms_pipe_crc_basic (read-crc)
[609.692972] Starting subtest: read-crc
[609.698313] Starting dynamic subtest: pipe-A-eDP-1
[611.695454] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.993s)
[611.792376] Starting dynamic subtest: pipe-B-eDP-1
[614.158471] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.444s)
[614.265646] Starting dynamic subtest: pipe-C-eDP-1
[616.526316] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.349s)
[616.530280] Subtest read-crc: SUCCESS (6.841s)
[617.750548] [121/162] (489s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[618.243942] Starting subtest: read-crc-frame-sequence
[618.249422] Starting dynamic subtest: pipe-A-eDP-1
[620.252718] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.997s)
[620.358076] Starting dynamic subtest: pipe-B-eDP-1
[622.689890] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.424s)
[622.789143] Starting dynamic subtest: pipe-C-eDP-1
[625.031339] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.316s)
[625.034095] Subtest read-crc-frame-sequence: SUCCESS (6.787s)
[626.292282] [122/162] (481s left) kms_pm_backlight (basic-brightness)
[626.796782] Starting subtest: basic-brightness
[627.295532] Starting dynamic subtest: eDP-1
[627.772283] Dynamic subtest eDP-1: SUCCESS (0.484s)
[627.776202] Subtest basic-brightness: SUCCESS (0.981s)
[629.089128] [123/162] (478s left) kms_pm_rpm (basic-pci-d3-state)
[631.601348] Starting subtest: basic-pci-d3-state
[633.553213] Subtest basic-pci-d3-state: SUCCESS (1.954s)
[634.194540] [124/162] (474s left) kms_pm_rpm (basic-rte)
[634.567242] Starting subtest: basic-rte
[638.485690] Subtest basic-rte: SUCCESS (3.917s)
[640.744294] [125/162] (467s left) kms_psr (psr-primary-page-flip)
[641.238236] Starting subtest: psr-primary-page-flip
[641.248680] Starting dynamic subtest: eDP-1
[643.987378] Dynamic subtest eDP-1: SUCCESS (2.738s)
[643.990050] Subtest psr-primary-page-flip: SUCCESS (2.750s)
[645.281904] [126/162] (463s left) kms_psr (psr-cursor-plane-move)
[645.816541] Starting subtest: psr-cursor-plane-move
[645.830398] Starting dynamic subtest: eDP-1
[648.415380] Dynamic subtest eDP-1: SUCCESS (2.587s)
[648.418657] Subtest psr-cursor-plane-move: SUCCESS (2.599s)
[649.617951] [127/162] (459s left) kms_psr (psr-sprite-plane-onoff)
[650.117671] Starting subtest: psr-sprite-plane-onoff
[650.121469] Starting dynamic subtest: eDP-1
[652.740284] Dynamic subtest eDP-1: SUCCESS (2.618s)
[652.755166] Subtest psr-sprite-plane-onoff: SUCCESS (2.630s)
[654.050106] [128/162] (455s left) kms_psr (psr-primary-mmap-gtt)
[654.543282] Starting subtest: psr-primary-mmap-gtt
[654.554354] Starting dynamic subtest: eDP-1
[657.334442] Dynamic subtest eDP-1: SUCCESS (2.784s)
[657.337304] Subtest psr-primary-mmap-gtt: SUCCESS (2.796s)
[658.588483] [129/162] (451s left) kms_setmode (basic-clone-single-crtc)
[658.978958] Starting subtest: basic-clone-single-crtc
[658.987952] Subtest basic-clone-single-crtc: SKIP (0.001s)
[659.456759] [130/162] (451s left) i915_pm_rps (basic-api)
[659.878525] Starting subtest: basic-api
[659.884685] Subtest basic-api: SKIP (0.005s)
[660.376971] [131/162] (450s left) prime_self_import (basic-llseek-bad)
[660.759306] Starting subtest: basic-llseek-bad
[660.781447] Subtest basic-llseek-bad: SUCCESS (0.015s)
[661.282954] [132/162] (450s left) prime_self_import (basic-llseek-size)
[661.651205] Starting subtest: basic-llseek-size
[661.673785] Subtest basic-llseek-size: SUCCESS (0.022s)
[662.160352] [133/162] (449s left) prime_self_import (basic-with_fd_dup)
[662.540416] Starting subtest: basic-with_fd_dup
[662.554136] Subtest basic-with_fd_dup: SUCCESS (0.021s)
[663.053577] [134/162] (449s left) prime_self_import (basic-with_one_bo)
[663.434213] Starting subtest: basic-with_one_bo
[663.448426] Subtest basic-with_one_bo: SUCCESS (0.022s)
[663.947809] [135/162] (448s left) prime_self_import (basic-with_one_bo_two_files)
[664.316339] Starting subtest: basic-with_one_bo_two_files
[664.339613] Subtest basic-with_one_bo_two_files: SUCCESS (0.018s)
[664.821955] [136/162] (448s left) prime_self_import (basic-with_two_bos)
[665.199761] Starting subtest: basic-with_two_bos
[665.213980] Subtest basic-with_two_bos: SUCCESS (0.021s)
[665.712885] [137/162] (447s left) prime_vgem (basic-fence-flip)
[666.162119] Starting subtest: basic-fence-flip
[667.613122] Subtest basic-fence-flip: SUCCESS (1.450s)
[668.213307] [138/162] (445s left) prime_vgem (basic-fence-mmap)
[668.655659] Starting subtest: basic-fence-mmap
[668.853963] Subtest basic-fence-mmap: SUCCESS (0.196s)
[669.353340] [139/162] (444s left) prime_vgem (basic-fence-read)
[669.791243] Starting subtest: basic-fence-read
[669.849816] Subtest basic-fence-read: SKIP (0.056s)
[670.354820] [140/162] (444s left) prime_vgem (basic-gtt)
[670.804743] Starting subtest: basic-gtt
[670.893954] Subtest basic-gtt: SUCCESS (0.088s)
[671.392431] [141/162] (443s left) prime_vgem (basic-read)
[671.838566] Starting subtest: basic-read
[671.896054] Subtest basic-read: SKIP (0.055s)
[672.422765] [142/162] (443s left) prime_vgem (basic-write)
[672.869884] Starting subtest: basic-write
[672.928908] Subtest basic-write: SKIP (0.056s)
[673.451179] [143/162] (442s left) vgem_basic (setversion)
[673.863886] Starting subtest: setversion
[673.875788] Subtest setversion: SUCCESS (0.000s)
[674.318137] [144/162] (441s left) vgem_basic (create)
[674.726116] Starting subtest: create
[674.729578] Subtest create: SUCCESS (0.002s)
[675.176515] [145/162] (441s left) vgem_basic (debugfs)
[675.585119] Starting subtest: debugfs
[675.589087] Subtest debugfs: SUCCESS (0.003s)
[676.077931] [146/162] (441s left) vgem_basic (dmabuf-export)
[676.486125] Starting subtest: dmabuf-export
[676.502624] Subtest dmabuf-export: SUCCESS (0.018s)
[676.986901] [147/162] (440s left) vgem_basic (dmabuf-fence)
[677.399953] Starting subtest: dmabuf-fence
[677.409101] Subtest dmabuf-fence: SUCCESS (0.003s)
[677.870612] [148/162] (440s left) vgem_basic (dmabuf-fence-before)
[678.277596] Starting subtest: dmabuf-fence-before
[678.281210] Subtest dmabuf-fence-before: SUCCESS (0.003s)
[678.749420] [149/162] (439s left) vgem_basic (dmabuf-mmap)
[679.155668] Starting subtest: dmabuf-mmap
[679.248537] Subtest dmabuf-mmap: SUCCESS (0.097s)
[679.708858] [150/162] (439s left) vgem_basic (mmap)
[680.112594] Starting subtest: mmap
[680.173353] Subtest mmap: SUCCESS (0.065s)
[680.641553] [151/162] (438s left) vgem_basic (second-client)
[681.045965] Starting subtest: second-client
[681.089911] Subtest second-client: SUCCESS (0.046s)
[681.556373] [152/162] (437s left) vgem_basic (sysfs)
[681.962682] Starting subtest: sysfs
[681.966131] Subtest sysfs: SUCCESS (0.004s)
[682.434599] [153/162] (437s left) core_hotunplug (unbind-rebind)
[683.133288] Starting subtest: unbind-rebind
[692.112381] Subtest unbind-rebind: SUCCESS (8.981s)
[692.523265] [154/162] (427s left) vgem_basic (unload)
[692.893355] Starting subtest: unload
[722.618331] Subtest unload: SUCCESS (29.690s)
[723.251854] [155/162] (397s left) i915_module_load (reload)
[723.619761] Starting subtest: reload
[739.380429] Subtest reload: SUCCESS (15.756s)
[739.815289] [156/162] (381s left) gem_lmem_swapping (basic)
[740.395268] Subtest basic: SKIP (0.000s)
[740.827099] [157/162] (380s left) gem_lmem_swapping (parallel-random-engines)
[741.249153] Subtest parallel-random-engines: SKIP (0.000s)
[741.684124] [158/162] (380s left) gem_lmem_swapping (random-engines)
[742.096236] Subtest random-engines: SKIP (0.000s)
[742.535514] [159/162] (379s left) gem_lmem_swapping (verify-random)
[742.946659] Subtest verify-random: SKIP (0.000s)
[743.369339] [160/162] (379s left) i915_pm_rpm (module-reload)
[746.669227] Starting subtest: module-reload
[784.534884] Subtest module-reload: SUCCESS (37.854s)
[784.797849] [FACT i915_pm_rpm (module-reload)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[784.811874] [FACT i915_pm_rpm (module-reload)] deleted: kernel.kmod_is_loaded.i915: true
[784.834862] [161/162] (338s left) i915_selftest (live)
[785.233332] Starting subtest: live
[785.244397] Starting dynamic subtest: sanitycheck
[795.668835] Dynamic subtest sanitycheck: SUCCESS (10.416s)
[795.742945] Starting dynamic subtest: uncore
[806.098655] Dynamic subtest uncore: SUCCESS (10.418s)
[806.169168] Starting dynamic subtest: workarounds
[819.122851] Dynamic subtest workarounds: SUCCESS (13.013s)
[819.198406] Starting dynamic subtest: gt_engines
[830.130655] Dynamic subtest gt_engines: SUCCESS (11.001s)
[830.206462] Starting dynamic subtest: gt_timelines
[874.587539] Dynamic subtest gt_timelines: SUCCESS (44.447s)
[874.661285] Starting dynamic subtest: gt_contexts
[885.065939] Dynamic subtest gt_contexts: SUCCESS (10.469s)
[885.139465] Starting dynamic subtest: gt_lrc
[899.152157] Dynamic subtest gt_lrc: SUCCESS (14.077s)
[899.221902] Starting dynamic subtest: gt_mocs
[910.792768] Dynamic subtest gt_mocs: SUCCESS (11.632s)
[910.862674] Starting dynamic subtest: gt_pm
[923.288692] Dynamic subtest gt_pm: SUCCESS (12.487s)
[923.362584] Starting dynamic subtest: gt_heartbeat
[933.866300] Dynamic subtest gt_heartbeat: SUCCESS (10.569s)
[933.937115] Starting dynamic subtest: gt_tlb
[945.602199] Dynamic subtest gt_tlb: SUCCESS (11.718s)
[945.671243] Starting dynamic subtest: requests
[966.300067] Dynamic subtest requests: SUCCESS (20.667s)
[966.367527] Starting dynamic subtest: migrate
[980.875647] Dynamic subtest migrate: SUCCESS (14.601s)
[980.954241] Starting dynamic subtest: active
[991.338745] Dynamic subtest active: SUCCESS (10.440s)
[991.412866] Starting dynamic subtest: objects
[1005.911877] Dynamic subtest objects: SUCCESS (14.569s)
[1006.002233] Starting dynamic subtest: mman
[1027.062828] Dynamic subtest mman: SUCCESS (21.139s)
[1027.150467] Starting dynamic subtest: dmabuf
[1037.774387] Dynamic subtest dmabuf: SUCCESS (10.703s)
[1037.844318] Starting dynamic subtest: vma
[1048.127568] Dynamic subtest vma: SUCCESS (10.344s)
[1048.201771] Starting dynamic subtest: coherency
[1079.313306] Dynamic subtest coherency: SUCCESS (31.174s)
[1079.385448] Starting dynamic subtest: gtt
[1097.961524] Dynamic subtest gtt: SUCCESS (18.640s)
[1098.029092] Starting dynamic subtest: gem
[1109.590496] Dynamic subtest gem: SUCCESS (11.620s)
[1109.662514] Starting dynamic subtest: evict
[1127.816246] Dynamic subtest evict: SUCCESS (18.215s)
[1127.890284] Starting dynamic subtest: hugepages
[1144.932613] Dynamic subtest hugepages: SUCCESS (17.103s)
[1145.009432] Starting dynamic subtest: gem_contexts
[1185.921224] Dynamic subtest gem_contexts: SUCCESS (40.950s)
[1185.998480] Starting dynamic subtest: client
[1196.553804] Dynamic subtest client: SUCCESS (10.650s)
[1196.622068] Starting dynamic subtest: gem_migrate
[1207.043797] Dynamic subtest gem_migrate: SUCCESS (10.477s)
[1207.140103] Starting dynamic subtest: reset
[1221.072596] Dynamic subtest reset: SUCCESS (14.012s)
[1221.144215] Starting dynamic subtest: memory_region
[1231.444496] Dynamic subtest memory_region: SUCCESS (10.360s)
[1231.523193] Starting dynamic subtest: hangcheck
[1262.874409] Dynamic subtest hangcheck: SUCCESS (31.421s)
[1262.949435] Starting dynamic subtest: execlists
[1273.286221] Dynamic subtest execlists: SUCCESS (10.403s)
[1273.359647] Starting dynamic subtest: ring_submission
[1283.737794] Dynamic subtest ring_submission: SUCCESS (10.453s)
[1283.818266] Starting dynamic subtest: perf
[1293.677750] Abort requested by sudo IGT_PING_HOSTNAME=10.211.124.1 IGT_CI_META_TEST=yes IGT_REBOOT_ON_FATAL_ERROR=yes LD_LIBRARY_PATH=/opt/igt/lib:/op [1161] via Terminated, terminating children
[1295.371650] [FACT i915_selftest (live)] new: kernel.kmod_is_loaded.i915: true
[1295.385132] Closing watchdogs
Done.