[46.877705] Initializing watchdogs [46.877769] /dev/watchdog0 [46.894322] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:9a49 Intel Tigerlake (Gen12) TigerLake-LP GT2 [Iris Xe Graphics] [46.900209] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [46.903109] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [46.904948] [001/133] (960s left) kms_big_fb (linear-addfb) [47.011074] Starting subtest: linear-addfb [47.011783] Subtest linear-addfb: SUCCESS (0.000s) [47.115499] [002/133] (960s left) gem_lmem_swapping (verify-ccs) [47.154358] Subtest verify-ccs: SKIP (0.000s) [47.195759] [003/133] (960s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats) [47.279746] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats [47.280488] Starting dynamic subtest: pipe-A [48.485139] Dynamic subtest pipe-A: SUCCESS (1.206s) [48.498154] Starting dynamic subtest: pipe-B [49.752207] Dynamic subtest pipe-B: SUCCESS (1.267s) [49.766272] Starting dynamic subtest: pipe-C [49.961609] Dynamic subtest pipe-C: SUCCESS (0.209s) [49.973329] Starting dynamic subtest: pipe-D [50.162190] Dynamic subtest pipe-D: SUCCESS (0.200s) [50.162921] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (2.883s) [50.327768] [004/133] (957s left) kms_flip (flip-vs-expired-vblank) [50.422935] Starting subtest: flip-vs-expired-vblank [50.424831] Starting dynamic subtest: A-HDMI-A1 [58.116744] Dynamic subtest A-HDMI-A1: SUCCESS (7.691s) [58.127195] Starting dynamic subtest: B-HDMI-A1 [65.773521] Dynamic subtest B-HDMI-A1: SUCCESS (7.652s) [65.782493] Starting dynamic subtest: C-HDMI-A1 [73.433951] Dynamic subtest C-HDMI-A1: SUCCESS (7.657s) [73.445302] Starting dynamic subtest: D-HDMI-A1 [81.097077] Dynamic subtest D-HDMI-A1: SUCCESS (7.666s) [81.098940] Subtest flip-vs-expired-vblank: SUCCESS (30.676s) [81.238596] [005/133] (926s left) kms_flip (2x-flip-vs-dpms-on-nop) [81.333979] Starting subtest: 2x-flip-vs-dpms-on-nop [81.350119] Subtest 2x-flip-vs-dpms-on-nop: SKIP (0.016s) [81.442784] [006/133] (926s left) gem_exec_balancer (bonded-semaphore) [81.484841] Starting subtest: bonded-semaphore [85.774914] Subtest bonded-semaphore: SUCCESS (4.278s) [85.949120] [007/133] (921s left) kms_big_fb (y-tiled-8bpp-rotate-90) [86.047883] Starting subtest: y-tiled-8bpp-rotate-90 [86.125680] Subtest y-tiled-8bpp-rotate-90: SKIP (0.077s) [86.234196] [008/133] (921s left) kms_cursor_legacy (2x-flip-vs-cursor-legacy) [86.320774] Starting subtest: 2x-flip-vs-cursor-legacy [86.323164] Subtest 2x-flip-vs-cursor-legacy: SKIP (0.002s) [86.379510] [009/133] (921s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt) [86.469448] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt [86.470793] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [86.567421] [010/133] (921s left) kms_cursor_legacy (cursorb-vs-flipa-toggle) [86.655440] Starting subtest: cursorB-vs-flipA-toggle [86.657834] Subtest cursorB-vs-flipA-toggle: SKIP (0.002s) [86.716322] [011/133] (921s left) kms_chamelium_frames (dp-crc-fast) [86.853199] Subtest dp-crc-fast: SKIP (0.000s) [86.945922] [012/133] (920s left) gem_ctx_persistence (legacy-engines-hostile) [86.987488] Starting subtest: legacy-engines-hostile [86.988306] Starting dynamic subtest: render [87.082501] Dynamic subtest render: SUCCESS (0.094s) [87.097142] Starting dynamic subtest: bsd1 [87.178695] Dynamic subtest bsd1: SUCCESS (0.095s) [87.192745] Starting dynamic subtest: bsd2 [87.268686] Dynamic subtest bsd2: SUCCESS (0.088s) [87.283017] Starting dynamic subtest: blt [87.355652] Dynamic subtest blt: SUCCESS (0.085s) [87.368758] Starting dynamic subtest: vebox [87.446544] Dynamic subtest vebox: SUCCESS (0.090s) [87.447538] Subtest legacy-engines-hostile: SUCCESS (0.459s) [87.518665] [013/133] (920s left) perf_pmu (busy-accuracy-50) [87.554454] Starting subtest: busy-accuracy-50 [87.555215] Starting dynamic subtest: rcs0 [89.080147] Dynamic subtest rcs0: SUCCESS (1.522s) [89.087179] Starting dynamic subtest: bcs0 [90.605166] Dynamic subtest bcs0: SUCCESS (1.524s) [90.613433] Starting dynamic subtest: vcs0 [92.129631] Dynamic subtest vcs0: SUCCESS (1.524s) [92.136903] Starting dynamic subtest: vcs1 [93.652674] Dynamic subtest vcs1: SUCCESS (1.522s) [93.659792] Starting dynamic subtest: vecs0 [95.177376] Dynamic subtest vecs0: SUCCESS (1.524s) [95.178403] Subtest busy-accuracy-50: SUCCESS (7.618s) [95.267799] [014/133] (912s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc) [95.359431] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc [95.360786] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [95.460937] [015/133] (912s left) gen7_exec_parse (load-register-reg) [95.498177] Subtest load-register-reg: SKIP (0.000s) [95.557256] [016/133] (912s left) kms_ccs (bad-rotation-90-4-tiled-dg2-rc-ccs) [95.642773] Starting subtest: bad-rotation-90-4-tiled-dg2-rc-ccs [95.643468] Starting dynamic subtest: pipe-A-HDMI-A-1 [95.650244] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s) [95.656666] Starting dynamic subtest: pipe-B-HDMI-A-1 [95.663517] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s) [95.669631] Starting dynamic subtest: pipe-C-HDMI-A-1 [95.676392] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s) [95.682432] Starting dynamic subtest: pipe-D-HDMI-A-1 [95.689058] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s) [95.690363] Subtest bad-rotation-90-4-tiled-dg2-rc-ccs: SKIP (0.005s) [95.879716] [017/133] (912s left) syncobj_timeline (etime-single-wait-all-available-unsubmitted) [95.919371] Starting subtest: etime-single-wait-all-available-unsubmitted [96.023691] Subtest etime-single-wait-all-available-unsubmitted: SUCCESS (0.104s) [96.117680] [018/133] (911s left) api_intel_bb (destroy-bb) [96.151950] Starting subtest: destroy-bb [96.159698] Subtest destroy-bb: SUCCESS (0.008s) [96.260600] [019/133] (911s left) gem_exec_params (invalid-flag) [96.296953] Starting subtest: invalid-flag [96.297680] Subtest invalid-flag: SUCCESS (0.000s) [96.388591] [020/133] (911s left) gem_exec_reloc (basic-write-wc-active) [96.425924] Starting subtest: basic-write-wc-active [96.560206] Subtest basic-write-wc-active: SUCCESS (0.125s) [96.667735] [021/133] (911s left) gem_render_copy (x-tiled-to-vebox-y-tiled) [96.707424] Starting subtest: x-tiled-to-vebox-y-tiled [96.708196] Starting dynamic subtest: smem [96.803715] Dynamic subtest smem: SUCCESS (0.096s) [96.804471] Subtest x-tiled-to-vebox-y-tiled: SUCCESS (0.096s) [96.977380] [022/133] (911s left) gem_exec_params (invalid-fence-in) [97.013553] Starting subtest: invalid-fence-in [97.014298] Subtest invalid-fence-in: SUCCESS (0.000s) [97.092403] [023/133] (911s left) i915_selftest (live) [97.945943] Starting subtest: live [97.946847] Starting dynamic subtest: sanitycheck [99.177825] Dynamic subtest sanitycheck: SUCCESS (1.231s) [99.187435] Starting dynamic subtest: uncore [100.366521] Dynamic subtest uncore: SUCCESS (1.188s) [100.372791] Starting dynamic subtest: workarounds [101.900568] Dynamic subtest workarounds: SUCCESS (1.533s) [101.907337] Starting dynamic subtest: gt_engines [103.677435] Dynamic subtest gt_engines: SUCCESS (1.776s) [103.684051] Starting dynamic subtest: gt_timelines [112.680749] Dynamic subtest gt_timelines: SUCCESS (9.001s) [112.694830] Starting dynamic subtest: gt_contexts [113.973899] Dynamic subtest gt_contexts: SUCCESS (1.292s) [113.980600] Starting dynamic subtest: gt_lrc [118.167774] Dynamic subtest gt_lrc: SUCCESS (4.193s) [118.173942] Starting dynamic subtest: gt_mocs [119.509698] Dynamic subtest gt_mocs: SUCCESS (1.341s) [119.516382] Starting dynamic subtest: gt_pm [140.936736] Dynamic subtest gt_pm: SUCCESS (21.425s) [140.943348] Starting dynamic subtest: gt_heartbeat [142.140718] Dynamic subtest gt_heartbeat: SUCCESS (1.203s) [142.146956] Starting dynamic subtest: gt_tlb [145.605754] Dynamic subtest gt_tlb: SUCCESS (3.464s) [145.612041] Starting dynamic subtest: requests [154.252838] Dynamic subtest requests: SUCCESS (8.646s) [154.261086] Starting dynamic subtest: migrate [158.506636] Dynamic subtest migrate: SUCCESS (4.253s) [158.517200] Starting dynamic subtest: active [159.739664] Dynamic subtest active: SUCCESS (1.232s) [159.746141] Starting dynamic subtest: objects [161.463519] Dynamic subtest objects: SUCCESS (1.723s) [161.473470] Starting dynamic subtest: mman [166.141432] Dynamic subtest mman: SUCCESS (4.676s) [166.147813] Starting dynamic subtest: dmabuf [167.425858] Dynamic subtest dmabuf: SUCCESS (1.283s) [167.435091] Starting dynamic subtest: vma [168.693605] Dynamic subtest vma: SUCCESS (1.266s) [168.699897] Starting dynamic subtest: coherency [171.465723] Dynamic subtest coherency: SUCCESS (2.771s) [171.480263] Starting dynamic subtest: gtt [179.932523] Dynamic subtest gtt: SUCCESS (8.465s) [179.939112] Starting dynamic subtest: gem [182.070701] Dynamic subtest gem: SUCCESS (2.137s) [182.077113] Starting dynamic subtest: evict [184.351553] Dynamic subtest evict: SUCCESS (2.279s) [184.358036] Starting dynamic subtest: hugepages [192.051632] Dynamic subtest hugepages: SUCCESS (7.698s) [192.057798] Starting dynamic subtest: gem_contexts [207.423507] Dynamic subtest gem_contexts: SUCCESS (15.370s) [207.429201] Starting dynamic subtest: client [208.679694] Dynamic subtest client: SUCCESS (1.254s) [208.689426] Starting dynamic subtest: gem_migrate [209.898666] Dynamic subtest gem_migrate: SUCCESS (1.217s) [209.905035] Starting dynamic subtest: reset [214.851702] Dynamic subtest reset: SUCCESS (4.951s) [214.866097] Starting dynamic subtest: memory_region [216.070650] Dynamic subtest memory_region: SUCCESS (1.217s) [216.077944] Starting dynamic subtest: hangcheck [246.038722] Dynamic subtest hangcheck: SUCCESS (29.966s) [246.053369] Starting dynamic subtest: execlists [259.822798] Dynamic subtest execlists: SUCCESS (13.782s) [259.833259] Starting dynamic subtest: ring_submission [261.054505] Dynamic subtest ring_submission: SUCCESS (1.230s) [261.066802] Starting dynamic subtest: perf [262.362537] Dynamic subtest perf: SUCCESS (1.306s) [262.368705] Starting dynamic subtest: slpc [263.550622] Dynamic subtest slpc: SUCCESS (1.186s) [263.561842] Starting dynamic subtest: guc [264.761593] Dynamic subtest guc: SUCCESS (1.209s) [264.768429] Starting dynamic subtest: guc_multi_lrc [265.953521] Dynamic subtest guc_multi_lrc: SUCCESS (1.190s) [265.960174] Starting dynamic subtest: guc_hang [267.157618] Dynamic subtest guc_hang: SUCCESS (1.202s) [267.167479] Starting dynamic subtest: late_gt_pm [268.458652] Dynamic subtest late_gt_pm: SUCCESS (1.299s) [268.459524] Subtest live: SUCCESS (170.511s) [268.479091] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true [268.482797] [024/133] (739s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip) [269.604609] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip [269.605992] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s) [269.710695] [FACT kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip)] new: kernel.kmod_is_loaded.i915: true [269.713242] [025/133] (738s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-pwrite) [269.806179] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-pwrite [269.807619] Subtest fbc-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s) [269.900202] [026/133] (738s left) kms_psr (fbc-pr-cursor-blt) [269.987199] Subtest fbc-pr-cursor-blt: SKIP (0.000s) [270.037538] [027/133] (738s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf) [270.125467] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (0.000s) [270.163441] [028/133] (738s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt) [270.255750] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt [270.257117] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [270.352566] [029/133] (738s left) gem_exec_reloc (basic-write-cpu-active) [270.395766] Starting subtest: basic-write-cpu-active [270.528039] Subtest basic-write-cpu-active: SUCCESS (0.123s) [270.812896] [030/133] (737s left) gem_close_race (basic-threads) [270.858130] Starting subtest: basic-threads [272.057967] Subtest basic-threads: SUCCESS (1.199s) [272.239698] [031/133] (736s left) perf_pmu (init-sema) [272.276682] Starting subtest: init-sema [272.277469] Starting dynamic subtest: rcs0 [272.279286] Dynamic subtest rcs0: SUCCESS (0.001s) [272.286041] Starting dynamic subtest: bcs0 [272.286744] Dynamic subtest bcs0: SUCCESS (0.000s) [272.293258] Starting dynamic subtest: vcs0 [272.293972] Dynamic subtest vcs0: SUCCESS (0.000s) [272.300478] Starting dynamic subtest: vcs1 [272.301174] Dynamic subtest vcs1: SUCCESS (0.000s) [272.307494] Starting dynamic subtest: vecs0 [272.308186] Dynamic subtest vecs0: SUCCESS (0.000s) [272.308876] Subtest init-sema: SUCCESS (0.008s) [272.342745] [032/133] (736s left) kms_getfb (getfb-handle-zero) [272.431067] Starting subtest: getfb-handle-zero [272.431773] Subtest getfb-handle-zero: SUCCESS (0.000s) [272.519877] [033/133] (736s left) gem_exercise_blt (fast-copy) [272.558306] Starting subtest: fast-copy [272.559039] Starting dynamic subtest: linear-smem-smem [272.579671] Dynamic subtest linear-smem-smem: SUCCESS (0.021s) [272.587404] Starting dynamic subtest: ymajor-smem-smem [272.598294] Dynamic subtest ymajor-smem-smem: SUCCESS (0.018s) [272.605953] Starting dynamic subtest: tile4-smem-smem [272.617425] Dynamic subtest tile4-smem-smem: SUCCESS (0.018s) [272.625165] Starting dynamic subtest: tile64-smem-smem [272.636510] Dynamic subtest tile64-smem-smem: SUCCESS (0.018s) [272.637215] Subtest fast-copy: SUCCESS (0.079s) [272.735835] [034/133] (736s left) kms_prop_blob (invalid-set-prop-any) [272.768657] Starting subtest: invalid-set-prop-any [272.769359] Subtest invalid-set-prop-any: SUCCESS (0.000s) [272.830138] [035/133] (736s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt) [272.921916] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt [272.923431] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [273.001532] [036/133] (735s left) kms_selftest (drm_format) [273.040864] Starting subtest: drm_format [273.046256] Starting dynamic subtest: drm_test_format_block_width_invalid [273.115148] Dynamic subtest drm_test_format_block_width_invalid: SUCCESS (0.068s) [273.132786] Starting dynamic subtest: drm_test_format_block_width_one_plane [273.183883] Dynamic subtest drm_test_format_block_width_one_plane: SUCCESS (0.064s) [273.201393] Starting dynamic subtest: drm_test_format_block_width_two_plane [273.258198] Dynamic subtest drm_test_format_block_width_two_plane: SUCCESS (0.071s) [273.275111] Starting dynamic subtest: drm_test_format_block_width_three_plane [273.334186] Dynamic subtest drm_test_format_block_width_three_plane: SUCCESS (0.073s) [273.351664] Starting dynamic subtest: drm_test_format_block_width_tiled [273.417980] Dynamic subtest drm_test_format_block_width_tiled: SUCCESS (0.081s) [273.435813] Starting dynamic subtest: drm_test_format_block_height_invalid [273.496232] Dynamic subtest drm_test_format_block_height_invalid: SUCCESS (0.074s) [273.513933] Starting dynamic subtest: drm_test_format_block_height_one_plane [273.561198] Dynamic subtest drm_test_format_block_height_one_plane: SUCCESS (0.062s) [273.578308] Starting dynamic subtest: drm_test_format_block_height_two_plane [273.628936] Dynamic subtest drm_test_format_block_height_two_plane: SUCCESS (0.065s) [273.646949] Starting dynamic subtest: drm_test_format_block_height_three_plane [273.705490] Dynamic subtest drm_test_format_block_height_three_plane: SUCCESS (0.071s) [273.722854] Starting dynamic subtest: drm_test_format_block_height_tiled [273.775438] Dynamic subtest drm_test_format_block_height_tiled: SUCCESS (0.067s) [273.793074] Starting dynamic subtest: drm_test_format_min_pitch_invalid [273.840409] Dynamic subtest drm_test_format_min_pitch_invalid: SUCCESS (0.062s) [273.857693] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_8bpp [273.907811] Dynamic subtest drm_test_format_min_pitch_one_plane_8bpp: SUCCESS (0.064s) [273.925624] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_16bpp [273.979744] Dynamic subtest drm_test_format_min_pitch_one_plane_16bpp: SUCCESS (0.070s) [273.996747] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_24bpp [274.044913] Dynamic subtest drm_test_format_min_pitch_one_plane_24bpp: SUCCESS (0.062s) [274.062354] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_32bpp [274.109029] Dynamic subtest drm_test_format_min_pitch_one_plane_32bpp: SUCCESS (0.060s) [274.126841] Starting dynamic subtest: drm_test_format_min_pitch_two_plane [274.179133] Dynamic subtest drm_test_format_min_pitch_two_plane: SUCCESS (0.067s) [274.196142] Starting dynamic subtest: drm_test_format_min_pitch_three_plane_8bpp [274.249172] Dynamic subtest drm_test_format_min_pitch_three_plane_8bpp: SUCCESS (0.067s) [274.266775] Starting dynamic subtest: drm_test_format_min_pitch_tiled [274.313859] Dynamic subtest drm_test_format_min_pitch_tiled: SUCCESS (0.061s) [274.314959] Subtest drm_format: SUCCESS (1.276s) [274.447471] [037/133] (734s left) kms_frontbuffer_tracking (fbcpsr-2p-pri-indfb-multidraw) [274.564757] Starting subtest: fbcpsr-2p-pri-indfb-multidraw [274.566135] Subtest fbcpsr-2p-pri-indfb-multidraw: SKIP (0.000s) [274.652613] [038/133] (734s left) gem_exec_flush (basic-wb-rw-default) [274.695232] Starting subtest: basic-wb-rw-default [280.123446] Subtest basic-wb-rw-default: SUCCESS (5.428s) [280.335829] [039/133] (728s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-render) [280.432259] Starting subtest: psr-1p-offscreen-pri-indfb-draw-render [280.433717] Subtest psr-1p-offscreen-pri-indfb-draw-render: SKIP (0.000s) [280.512507] [040/133] (728s left) perf_pmu (all-busy-check-all) [280.549924] Starting subtest: all-busy-check-all [281.070067] Subtest all-busy-check-all: SUCCESS (0.521s) [281.134721] [041/133] (727s left) prime_mmap (test_errors) [281.169112] Starting subtest: test_errors [281.169813] Starting dynamic subtest: test_errors-smem [281.175066] Dynamic subtest test_errors-smem: SUCCESS (0.006s) [281.175760] Subtest test_errors: SUCCESS (0.007s) [281.249112] [042/133] (727s left) kms_big_fb (yf-tiled-addfb-size-overflow) [281.348381] Starting subtest: yf-tiled-addfb-size-overflow [281.349786] Subtest yf-tiled-addfb-size-overflow: SKIP (0.000s) [281.430126] [043/133] (727s left) kms_flip (2x-plain-flip-fb-recreate) [281.519606] Starting subtest: 2x-plain-flip-fb-recreate [281.528711] Subtest 2x-plain-flip-fb-recreate: SKIP (0.009s) [281.612325] [044/133] (727s left) kms_psr (pr-suspend) [281.699793] Subtest pr-suspend: SKIP (0.000s) [281.740114] [045/133] (727s left) gem_exec_reloc (basic-concurrent16) [281.779164] Starting subtest: basic-concurrent16 [287.227179] Subtest basic-concurrent16: SUCCESS (5.414s) [287.327999] [046/133] (721s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-onoff) [287.418734] Starting subtest: psr-1p-primscrn-cur-indfb-onoff [287.420113] Subtest psr-1p-primscrn-cur-indfb-onoff: SKIP (0.000s) [287.504152] [047/133] (721s left) kms_content_protection (dp-mst-type-0-suspend-resume) [287.594370] Starting subtest: dp-mst-type-0-suspend-resume [287.595752] Subtest dp-mst-type-0-suspend-resume: SKIP (0.000s) [287.689614] [048/133] (721s left) gem_exec_schedule (u-lateslice) [287.733072] Starting subtest: u-lateslice [287.733799] Starting dynamic subtest: rcs0 [287.750130] Dynamic subtest rcs0: SUCCESS (0.017s) [287.758617] Starting dynamic subtest: bcs0 [287.766991] Dynamic subtest bcs0: SUCCESS (0.016s) [287.775590] Starting dynamic subtest: vcs0 [287.783155] Dynamic subtest vcs0: SUCCESS (0.015s) [287.791599] Starting dynamic subtest: vcs1 [287.800092] Dynamic subtest vcs1: SUCCESS (0.016s) [287.808513] Starting dynamic subtest: vecs0 [287.815926] Dynamic subtest vecs0: SUCCESS (0.015s) [287.816701] Subtest u-lateslice: SUCCESS (0.083s) [288.115923] [049/133] (721s left) fbdev (unaligned-write) [288.154480] Starting subtest: unaligned-write [288.279896] Subtest unaligned-write: SUCCESS (0.117s) [288.330483] [050/133] (721s left) perf (sysctl-defaults) [288.387761] Starting subtest: sysctl-defaults [288.388462] Subtest sysctl-defaults: SUCCESS (0.000s) [288.442985] [051/133] (721s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc) [288.530337] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs-cc [288.531061] Starting dynamic subtest: pipe-A-HDMI-A-1 [288.537918] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s) [288.544947] Starting dynamic subtest: pipe-B-HDMI-A-1 [288.551816] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s) [288.558626] Starting dynamic subtest: pipe-C-HDMI-A-1 [288.565431] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s) [288.572129] Starting dynamic subtest: pipe-D-HDMI-A-1 [288.578994] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.001s) [288.580352] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.009s) [288.794563] [052/133] (720s left) gem_ctx_shared (q-smoketest-all) [288.837800] Starting subtest: Q-smoketest-all [321.120754] Subtest Q-smoketest-all: SUCCESS (32.270s) [321.287784] [053/133] (688s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling) [321.380244] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling [321.381706] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (0.000s) [321.433328] [054/133] (688s left) kms_flip (flip-vs-modeset-vs-hang) [321.520682] Starting subtest: flip-vs-modeset-vs-hang [321.521559] Starting dynamic subtest: A-HDMI-A1 [349.822848] Dynamic subtest A-HDMI-A1: SUCCESS (28.268s) [349.832008] Starting dynamic subtest: D-HDMI-A1 [377.469224] Dynamic subtest D-HDMI-A1: SUCCESS (27.645s) [377.469928] Subtest flip-vs-modeset-vs-hang: SUCCESS (55.920s) [377.556197] [055/133] (632s left) gem_wait (busy) [377.604092] Starting subtest: busy [377.604870] Starting dynamic subtest: all-engines [378.120072] Dynamic subtest all-engines: SUCCESS (0.515s) [378.128104] Starting dynamic subtest: rcs0 [378.637969] Dynamic subtest rcs0: SUCCESS (0.517s) [378.647074] Starting dynamic subtest: bcs0 [379.151846] Dynamic subtest bcs0: SUCCESS (0.513s) [379.160825] Starting dynamic subtest: vcs0 [379.665965] Dynamic subtest vcs0: SUCCESS (0.513s) [379.674638] Starting dynamic subtest: vcs1 [380.179891] Dynamic subtest vcs1: SUCCESS (0.513s) [380.188047] Starting dynamic subtest: vecs0 [380.695935] Dynamic subtest vecs0: SUCCESS (0.515s) [380.696656] Subtest busy: SUCCESS (3.093s) [380.886694] [056/133] (628s left) kms_plane (pixel-format-y-tiled-ccs-modifier) [380.976850] Starting subtest: pixel-format-y-tiled-ccs-modifier [380.978383] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s) [381.035722] [057/133] (628s left) gem_eio (in-flight-contexts-immediate) [381.079333] Starting subtest: in-flight-contexts-immediate [394.858165] Subtest in-flight-contexts-immediate: SUCCESS (13.775s) [394.972916] [058/133] (614s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-render) [395.063715] Starting subtest: psr-2p-primscrn-spr-indfb-draw-render [395.065070] Subtest psr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s) [395.167156] [059/133] (614s left) kms_frontbuffer_tracking (psr-1p-rte) [395.257588] Starting subtest: psr-1p-rte [395.258916] Subtest psr-1p-rte: SKIP (0.000s) [395.347571] [060/133] (614s left) kms_cursor_crc (cursor-rapid-movement-64x64) [395.436168] Starting subtest: cursor-rapid-movement-64x64 [395.441181] Starting dynamic subtest: pipe-A-HDMI-A-1 [395.697459] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.255s) [395.730450] Starting dynamic subtest: pipe-D-HDMI-A-1 [395.945023] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.221s) [395.945771] Subtest cursor-rapid-movement-64x64: SUCCESS (0.509s) [396.074406] [061/133] (613s left) kms_busy (basic-hang) [396.167836] Starting subtest: basic-hang [396.170031] Starting dynamic subtest: flip-pipe-A [396.512499] Dynamic subtest flip-pipe-A: SUCCESS (0.343s) [396.524409] Starting dynamic subtest: modeset-pipe-A [397.060436] Dynamic subtest modeset-pipe-A: SUCCESS (0.546s) [397.070576] Starting dynamic subtest: flip-pipe-D [397.348339] Dynamic subtest flip-pipe-D: SUCCESS (0.284s) [397.356990] Starting dynamic subtest: modeset-pipe-D [397.857496] Dynamic subtest modeset-pipe-D: SUCCESS (0.508s) [397.859308] Subtest basic-hang: SUCCESS (1.691s) [397.986754] [062/133] (611s left) kms_debugfs (display-off-read-all) [398.075995] Starting subtest: display-off-read-all [398.130585] Subtest display-off-read-all: SUCCESS (0.055s) [398.231507] [063/133] (611s left) kms_cursor_crc (cursor-onscreen-64x21) [398.320279] Starting subtest: cursor-onscreen-64x21 [398.325976] Starting dynamic subtest: pipe-A-HDMI-A-1 [399.494304] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.169s) [399.527697] Starting dynamic subtest: pipe-D-HDMI-A-1 [400.668041] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.147s) [400.668806] Subtest cursor-onscreen-64x21: SUCCESS (2.348s) [400.797882] [064/133] (609s left) kms_rotation_crc (multiplane-rotation-cropping-top) [400.888058] Starting subtest: multiplane-rotation-cropping-top [426.507344] Subtest multiplane-rotation-cropping-top: SUCCESS (25.620s) [426.616549] [065/133] (583s left) kms_addfb_basic (basic-y-tiled-legacy) [426.658835] Starting subtest: basic-y-tiled-legacy [426.659503] Subtest basic-y-tiled-legacy: SUCCESS (0.000s) [426.809768] [066/133] (583s left) gem_mmap (basic-small-bo) [426.842676] Starting subtest: basic-small-bo [427.349663] Subtest basic-small-bo: SUCCESS (0.506s) [427.557214] [067/133] (582s left) gem_userptr_blits (sync-overlap) [427.723131] Starting subtest: sync-overlap [427.723897] Subtest sync-overlap: SUCCESS (0.000s) [427.834991] [068/133] (582s left) gem_spin_batch (resubmit-all) [427.877707] Starting subtest: resubmit-all [427.878453] Starting dynamic subtest: rcs0 [427.881934] Dynamic subtest rcs0: SUCCESS (0.004s) [427.892557] Starting dynamic subtest: bcs0 [427.893271] Dynamic subtest bcs0: SUCCESS (0.002s) [427.901865] Starting dynamic subtest: vcs0 [427.902580] Dynamic subtest vcs0: SUCCESS (0.001s) [427.910040] Starting dynamic subtest: vcs1 [427.910741] Dynamic subtest vcs1: SUCCESS (0.002s) [427.918369] Starting dynamic subtest: vecs0 [427.919057] Dynamic subtest vecs0: SUCCESS (0.002s) [427.919739] Subtest resubmit-all: SUCCESS (0.016s) [428.076349] [069/133] (582s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-mc-ccs) [428.115518] Starting subtest: y-tiled-ccs-to-yf-tiled-mc-ccs [428.116235] Starting dynamic subtest: smem [428.198511] Dynamic subtest smem: SUCCESS (0.082s) [428.199272] Subtest y-tiled-ccs-to-yf-tiled-mc-ccs: SUCCESS (0.083s) [428.420399] [070/133] (581s left) gem_exec_balancer (parallel-out-fence) [428.584160] Subtest parallel-out-fence: SKIP (0.000s) [428.649373] [071/133] (581s left) i915_pm_rpm (system-suspend-execbuf) [440.124304] Starting subtest: system-suspend-execbuf [482.632037] Subtest system-suspend-execbuf: SUCCESS (27.118s) [482.859394] [072/133] (527s left) gem_mmap (big-bo) [482.895191] Starting subtest: big-bo [482.996269] Subtest big-bo: SUCCESS (0.101s) [483.093975] [073/133] (527s left) kms_vblank (wait-idle-hang) [483.225548] Starting subtest: wait-idle-hang [483.226272] Starting dynamic subtest: pipe-A-HDMI-A-1 [497.311123] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (14.077s) [497.322136] Starting dynamic subtest: pipe-D-HDMI-A-1 [511.119127] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (13.800s) [511.119830] Subtest wait-idle-hang: SUCCESS (27.884s) [511.262167] [074/133] (499s left) gem_exec_schedule (noreorder-priority) [511.444532] Starting subtest: noreorder-priority [511.445410] Starting dynamic subtest: rcs0 [512.569025] Dynamic subtest rcs0: SUCCESS (1.125s) [512.582045] Starting dynamic subtest: bcs0 [513.690859] Dynamic subtest bcs0: SUCCESS (1.118s) [513.704841] Starting dynamic subtest: vcs0 [514.809859] Dynamic subtest vcs0: SUCCESS (1.116s) [514.823120] Starting dynamic subtest: vcs1 [515.921604] Dynamic subtest vcs1: SUCCESS (1.108s) [515.933644] Starting dynamic subtest: vecs0 [517.040707] Dynamic subtest vecs0: SUCCESS (1.117s) [517.041896] Subtest noreorder-priority: SUCCESS (5.598s) [517.221057] [075/133] (493s left) kms_rotation_crc (primary-y-tiled-reflect-x-180) [517.309272] Starting subtest: primary-y-tiled-reflect-x-180 [522.309710] Subtest primary-y-tiled-reflect-x-180: SUCCESS (4.999s) [522.506502] [076/133] (487s left) kms_psr (fbc-pr-primary-mmap-gtt) [522.593798] Subtest fbc-pr-primary-mmap-gtt: SKIP (0.000s) [522.637419] [077/133] (487s left) prime_busy (before-wait) [522.674376] Starting subtest: before-wait [522.679599] Starting dynamic subtest: rcs0 [522.703262] Dynamic subtest rcs0: SUCCESS (0.023s) [522.713415] Starting dynamic subtest: bcs0 [522.723389] Dynamic subtest bcs0: SUCCESS (0.019s) [522.733362] Starting dynamic subtest: vcs0 [522.738608] Dynamic subtest vcs0: SUCCESS (0.014s) [522.748603] Starting dynamic subtest: vcs1 [522.759393] Dynamic subtest vcs1: SUCCESS (0.019s) [522.769540] Starting dynamic subtest: vecs0 [522.774936] Dynamic subtest vecs0: SUCCESS (0.014s) [522.885141] Subtest before-wait: SUCCESS (0.209s) [522.953716] [078/133] (487s left) gem_ctx_persistence (engines-mixed) [522.991778] Starting subtest: engines-mixed [522.992498] Starting dynamic subtest: rcs0 [523.044801] Dynamic subtest rcs0: SUCCESS (0.052s) [523.062684] Starting dynamic subtest: bcs0 [523.092829] Dynamic subtest bcs0: SUCCESS (0.045s) [523.110383] Starting dynamic subtest: vcs0 [523.142901] Dynamic subtest vcs0: SUCCESS (0.048s) [523.160857] Starting dynamic subtest: vcs1 [523.197847] Dynamic subtest vcs1: SUCCESS (0.052s) [523.216581] Starting dynamic subtest: vecs0 [523.254937] Dynamic subtest vecs0: SUCCESS (0.054s) [523.256169] Subtest engines-mixed: SUCCESS (0.264s) [523.325180] [079/133] (487s left) perf (low-oa-exponent-permissions) [523.409701] Starting subtest: low-oa-exponent-permissions [523.447029] Subtest low-oa-exponent-permissions: SUCCESS (0.037s) [523.495551] [080/133] (487s left) kms_cursor_legacy (2x-long-cursor-vs-flip-legacy) [523.581213] Starting subtest: 2x-long-cursor-vs-flip-legacy [523.583189] Subtest 2x-long-cursor-vs-flip-legacy: SKIP (0.002s) [523.642781] [081/133] (487s left) gem_exec_params (rel-constants-invalid-ring) [523.679390] Starting subtest: rel-constants-invalid-ring [523.680155] Subtest rel-constants-invalid-ring: SUCCESS (0.000s) [523.767139] [082/133] (486s left) kms_pm_backlight (fade-with-suspend) [523.856953] Subtest fade-with-suspend: SKIP (0.000s) [523.898129] [083/133] (486s left) gem_readwrite (new-obj) [523.932801] Starting subtest: new-obj [523.934234] Subtest new-obj: SUCCESS (0.000s) [524.026489] [084/133] (486s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt) [524.116673] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt [524.118133] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [524.210158] [085/133] (486s left) gem_mmap_wc (write-wc-read-gtt) [524.243893] Starting subtest: write-wc-read-gtt [524.556366] Subtest write-wc-read-gtt: SUCCESS (0.304s) [524.661880] [086/133] (486s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-gtt) [524.751051] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-gtt [525.917707] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-gtt: SUCCESS (1.166s) [526.039433] [087/133] (484s left) kms_ccs (crc-primary-rotation-180-y-tiled-ccs) [526.128210] Starting subtest: crc-primary-rotation-180-y-tiled-ccs [526.128938] Starting dynamic subtest: pipe-A-HDMI-A-1 [526.135623] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s) [526.145716] Starting dynamic subtest: pipe-B-HDMI-A-1 [526.152499] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s) [526.161123] Starting dynamic subtest: pipe-C-HDMI-A-1 [526.167948] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s) [526.176448] Starting dynamic subtest: pipe-D-HDMI-A-1 [526.183185] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.001s) [526.184514] Subtest crc-primary-rotation-180-y-tiled-ccs: SKIP (0.009s) [526.371165] [088/133] (484s left) gem_exec_whisper (basic-fds) [526.414811] Starting subtest: basic-fds [529.437981] Subtest basic-fds: SUCCESS (3.021s) [529.628639] [089/133] (481s left) gem_exec_reloc (basic-wc-cpu-active) [529.667172] Starting subtest: basic-wc-cpu-active [529.797090] Subtest basic-wc-cpu-active: SUCCESS (0.121s) [529.915264] [090/133] (481s left) kms_pm_rpm (legacy-planes) [541.373537] Starting subtest: legacy-planes [541.374499] Starting dynamic subtest: plane-65 [549.701913] Dynamic subtest plane-65: SUCCESS (8.326s) [549.716209] Starting dynamic subtest: plane-95 [558.081123] Dynamic subtest plane-95: SUCCESS (8.374s) [558.099963] Starting dynamic subtest: plane-125 [566.269235] Dynamic subtest plane-125: SUCCESS (8.190s) [566.283369] Starting dynamic subtest: plane-135 [574.472629] Dynamic subtest plane-135: SUCCESS (8.208s) [574.486714] Starting dynamic subtest: plane-145 [582.678650] Dynamic subtest plane-145: SUCCESS (8.209s) [582.699489] Starting dynamic subtest: plane-155 [591.169914] Dynamic subtest plane-155: SUCCESS (8.492s) [591.171403] Subtest legacy-planes: SUCCESS (49.816s) [591.344062] [091/133] (419s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs) [591.430357] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs [591.431055] Starting dynamic subtest: pipe-A-HDMI-A-1 [591.437649] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s) [591.446517] Starting dynamic subtest: pipe-B-HDMI-A-1 [591.453145] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s) [591.461691] Starting dynamic subtest: pipe-C-HDMI-A-1 [591.468214] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s) [591.476644] Starting dynamic subtest: pipe-D-HDMI-A-1 [591.483268] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s) [591.484568] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs: SKIP (0.007s) [591.666445] [092/133] (419s left) i915_module_load (reload-no-display) [591.698333] Starting subtest: reload-no-display [596.835016] Subtest reload-no-display: SUCCESS (5.130s) [596.861178] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true [596.864982] [093/133] (414s left) kms_frontbuffer_tracking (fbc-tiling-y) [597.955165] Starting subtest: fbc-tiling-y [599.303093] Subtest fbc-tiling-y: SUCCESS (1.348s) [599.430077] [FACT kms_frontbuffer_tracking (fbc-tiling-y)] new: kernel.kmod_is_loaded.i915: true [599.432444] [094/133] (411s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled) [599.467702] Starting subtest: multi-wait-for-submit-submitted-signaled [599.468401] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.001s) [599.534906] [095/133] (411s left) syncobj_timeline (wait-all-interrupted) [599.569298] Starting subtest: wait-all-interrupted [599.672934] Subtest wait-all-interrupted: SUCCESS (0.103s) [599.747460] [096/133] (411s left) gem_exec_fence (syncobj-channel) [600.088611] Starting subtest: syncobj-channel [601.119786] Subtest syncobj-channel: SUCCESS (1.022s) [601.421125] [FACT gem_exec_fence (syncobj-channel)] new: kernel.kmod_is_loaded.vgem: true [601.423399] [097/133] (409s left) kms_plane_scaling (plane-upscale-factor-0-25-with-pixel-format) [601.511102] Starting subtest: plane-upscale-factor-0-25-with-pixel-format [601.511783] Starting dynamic subtest: pipe-A [602.619014] Dynamic subtest pipe-A: SUCCESS (1.108s) [602.630254] Starting dynamic subtest: pipe-B [603.794654] Dynamic subtest pipe-B: SUCCESS (1.175s) [603.804465] Starting dynamic subtest: pipe-C [603.996456] Dynamic subtest pipe-C: SUCCESS (0.201s) [604.009032] Starting dynamic subtest: pipe-D [604.198384] Dynamic subtest pipe-D: SUCCESS (0.201s) [604.199108] Subtest plane-upscale-factor-0-25-with-pixel-format: SUCCESS (2.689s) [604.370025] [098/133] (406s left) kms_plane_alpha_blend (coverage-vs-premult-vs-constant) [604.460078] Starting subtest: coverage-vs-premult-vs-constant [604.527514] Starting dynamic subtest: pipe-A-HDMI-A-1 [604.790657] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.263s) [604.799896] Starting dynamic subtest: pipe-D-HDMI-A-1 [605.073014] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.280s) [605.073709] Subtest coverage-vs-premult-vs-constant: SUCCESS (0.614s) [605.210042] [099/133] (406s left) kms_properties (get_properties-sanity-atomic) [605.295196] Starting subtest: get_properties-sanity-atomic [605.299388] Subtest get_properties-sanity-atomic: SUCCESS (0.004s) [605.355571] [100/133] (406s left) kms_invalid_mode (clock-too-high) [605.440929] Starting subtest: clock-too-high [605.441616] Starting dynamic subtest: pipe-A-HDMI-A-1 [605.502027] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.060s) [605.511562] Starting dynamic subtest: pipe-B-HDMI-A-1 [605.513973] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.009s) [605.522226] Starting dynamic subtest: pipe-C-HDMI-A-1 [605.523010] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.008s) [605.532878] Starting dynamic subtest: pipe-D-HDMI-A-1 [605.535389] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.009s) [605.536055] Subtest clock-too-high: SUCCESS (0.094s) [605.660041] [101/133] (405s left) kms_psr (psr2-cursor-render) [605.746955] Subtest psr2-cursor-render: SKIP (0.000s) [605.786828] [102/133] (405s left) syncobj_timeline (invalid-multi-wait-unsubmitted) [605.820575] Starting subtest: invalid-multi-wait-unsubmitted [605.822408] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s) [605.885033] [103/133] (405s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [605.970362] Starting subtest: basic-flip-after-cursor-legacy [606.481578] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.511s) [606.620508] [104/133] (404s left) drm_buddy (drm_buddy) [606.655722] Starting subtest: drm_buddy [606.657113] Subtest drm_buddy: SKIP (0.000s) [606.713772] [105/133] (404s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-signaled) [606.748365] Starting subtest: etime-multi-wait-all-available-unsubmitted-signaled [606.848972] Subtest etime-multi-wait-all-available-unsubmitted-signaled: SUCCESS (0.101s) [606.928202] [106/133] (404s left) core_auth (basic-auth) [606.961002] Starting subtest: basic-auth [606.961701] Subtest basic-auth: SUCCESS (0.001s) [607.023145] [107/133] (404s left) vgem_basic (dmabuf-mmap) [607.060398] Starting subtest: dmabuf-mmap [607.068457] Subtest dmabuf-mmap: SUCCESS (0.009s) [607.119970] [108/133] (404s left) gem_eio (in-flight-10ms) [607.167579] Starting subtest: in-flight-10ms [609.460340] Subtest in-flight-10ms: SUCCESS (2.293s) [609.590188] [109/133] (402s left) i915_drm_fdinfo (busy-idle) [609.626386] Starting subtest: busy-idle [609.627132] Starting dynamic subtest: rcs0 [610.249544] Dynamic subtest rcs0: SUCCESS (0.623s) [610.261556] Starting dynamic subtest: bcs0 [610.874103] Dynamic subtest bcs0: SUCCESS (0.620s) [610.883800] Starting dynamic subtest: vcs0 [611.496083] Dynamic subtest vcs0: SUCCESS (0.621s) [611.509087] Starting dynamic subtest: vcs1 [612.121094] Dynamic subtest vcs1: SUCCESS (0.621s) [612.131082] Starting dynamic subtest: vecs0 [612.744134] Dynamic subtest vecs0: SUCCESS (0.622s) [612.745111] Subtest busy-idle: SUCCESS (3.118s) [612.808147] [110/133] (398s left) kms_plane_cursor (primary) [612.896284] Starting subtest: primary [612.897772] Starting dynamic subtest: pipe-A-HDMI-A-1-size-64 [614.109407] Dynamic subtest pipe-A-HDMI-A-1-size-64: SUCCESS (1.212s) [614.147205] Starting dynamic subtest: pipe-A-HDMI-A-1-size-128 [615.351106] Dynamic subtest pipe-A-HDMI-A-1-size-128: SUCCESS (1.216s) [615.393039] Starting dynamic subtest: pipe-A-HDMI-A-1-size-256 [616.592906] Dynamic subtest pipe-A-HDMI-A-1-size-256: SUCCESS (1.216s) [616.682963] Starting dynamic subtest: pipe-B-HDMI-A-1-size-64 [617.919493] Dynamic subtest pipe-B-HDMI-A-1-size-64: SUCCESS (1.251s) [617.950214] Starting dynamic subtest: pipe-B-HDMI-A-1-size-128 [619.152769] Dynamic subtest pipe-B-HDMI-A-1-size-128: SUCCESS (1.216s) [619.183447] Starting dynamic subtest: pipe-B-HDMI-A-1-size-256 [620.386232] Dynamic subtest pipe-B-HDMI-A-1-size-256: SUCCESS (1.216s) [620.460394] Starting dynamic subtest: pipe-C-HDMI-A-1-size-64 [621.705453] Dynamic subtest pipe-C-HDMI-A-1-size-64: SUCCESS (1.253s) [621.732830] Starting dynamic subtest: pipe-C-HDMI-A-1-size-128 [622.930583] Dynamic subtest pipe-C-HDMI-A-1-size-128: SUCCESS (1.208s) [622.964523] Starting dynamic subtest: pipe-C-HDMI-A-1-size-256 [624.164015] Dynamic subtest pipe-C-HDMI-A-1-size-256: SUCCESS (1.216s) [624.239819] Starting dynamic subtest: pipe-D-HDMI-A-1-size-64 [625.485781] Dynamic subtest pipe-D-HDMI-A-1-size-64: SUCCESS (1.254s) [625.516610] Starting dynamic subtest: pipe-D-HDMI-A-1-size-128 [626.719306] Dynamic subtest pipe-D-HDMI-A-1-size-128: SUCCESS (1.216s) [626.750215] Starting dynamic subtest: pipe-D-HDMI-A-1-size-256 [627.953013] Dynamic subtest pipe-D-HDMI-A-1-size-256: SUCCESS (1.216s) [628.019928] Subtest primary: SUCCESS (15.125s) [628.126474] [111/133] (383s left) api_intel_allocator (two-level-inception-interruptible) [628.162653] Starting subtest: two-level-inception-interruptible [633.581026] Subtest two-level-inception-interruptible: SUCCESS (5.419s) [633.704442] [112/133] (378s left) kms_draw_crc (draw-method-mmap-cpu) [633.791399] Starting subtest: draw-method-mmap-cpu [633.792145] Starting dynamic subtest: xrgb8888-untiled [633.946738] Dynamic subtest xrgb8888-untiled: SUCCESS (0.154s) [633.966816] Starting dynamic subtest: rgb565-untiled [634.105101] Dynamic subtest rgb565-untiled: SUCCESS (0.156s) [634.124659] Starting dynamic subtest: xrgb2101010-untiled [634.255049] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.148s) [634.274384] Starting dynamic subtest: xbgr16161616f-untiled [634.405127] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.147s) [634.424776] Starting dynamic subtest: xrgb8888-xtiled [634.496719] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.089s) [634.515798] Starting dynamic subtest: rgb565-xtiled [634.588389] Dynamic subtest rgb565-xtiled: SUCCESS (0.089s) [634.605434] Starting dynamic subtest: xrgb2101010-xtiled [634.671665] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.081s) [634.691208] Starting dynamic subtest: xbgr16161616f-xtiled [634.755004] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.081s) [634.774426] Starting dynamic subtest: xrgb8888-ytiled [634.846841] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.089s) [634.869428] Starting dynamic subtest: rgb565-ytiled [634.946909] Dynamic subtest rgb565-ytiled: SUCCESS (0.097s) [634.963874] Starting dynamic subtest: xrgb2101010-ytiled [635.030256] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.080s) [635.051169] Starting dynamic subtest: xbgr16161616f-ytiled [635.121753] Dynamic subtest xbgr16161616f-ytiled: SUCCESS (0.088s) [635.125280] Subtest draw-method-mmap-cpu: SUCCESS (1.332s) [635.238912] [113/133] (376s left) gem_set_tiling_vs_gtt [635.719340] [114/133] (376s left) gem_softpin (evict-snoop) [635.757969] Starting subtest: evict-snoop [635.759357] Subtest evict-snoop: SKIP (0.000s) [635.817844] [115/133] (376s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions-varying-size) [635.906167] Starting subtest: cursor-vs-flip-atomic-transitions-varying-size [668.113743] Subtest cursor-vs-flip-atomic-transitions-varying-size: SUCCESS (32.205s) [668.240117] [116/133] (343s left) kms_cdclk (mode-transition-all-outputs) [668.275228] Subtest mode-transition-all-outputs: SKIP (0.000s) [668.315461] [117/133] (343s left) kms_psr (fbc-psr2-sprite-mmap-gtt) [668.404878] Subtest fbc-psr2-sprite-mmap-gtt: SKIP (0.000s) [668.450090] [118/133] (343s left) gem_workarounds (suspend-resume-context) [668.501362] Starting subtest: suspend-resume-context [685.027607] Subtest suspend-resume-context: SUCCESS (1.198s) [694.138635] [119/133] (327s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-async-flip) [694.241478] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-async-flip [694.582524] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.340s) [694.713452] [120/133] (326s left) kms_chamelium_hpd (vga-hpd-fast) [694.851032] Subtest vga-hpd-fast: SKIP (0.000s) [694.939485] [121/133] (326s left) gem_create (create-ext-cpu-access-sanity-check) [695.095385] Starting subtest: create-ext-cpu-access-sanity-check [695.097800] Subtest create-ext-cpu-access-sanity-check: SKIP (0.001s) [695.172931] [122/133] (326s left) vgem_basic (second-client) [695.214576] Starting subtest: second-client [695.234983] Subtest second-client: SUCCESS (0.017s) [695.295869] [123/133] (326s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt) [695.386457] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt [695.387869] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s) [695.469723] [124/133] (325s left) kms_big_fb (x-tiled-addfb) [695.565996] Starting subtest: x-tiled-addfb [695.566688] Subtest x-tiled-addfb: SUCCESS (0.000s) [695.661147] [125/133] (325s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-render) [695.755146] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-render [696.843919] Subtest fbc-1p-offscreen-pri-indfb-draw-render: SUCCESS (1.087s) [696.978442] [126/133] (324s left) vgem_basic (bad-fence) [697.016925] Starting subtest: bad-fence [697.017667] Subtest bad-fence: SUCCESS (0.000s) [697.074390] [127/133] (324s left) gem_mmap_gtt (hang-user) [697.109183] Starting subtest: hang-user [732.771108] Subtest hang-user: SUCCESS (35.650s) [732.897060] [128/133] (288s left) sw_sync (alloc_merge_fence) [732.930826] Starting subtest: alloc_merge_fence [732.931559] Subtest alloc_merge_fence: SUCCESS (0.000s) [732.988098] [129/133] (288s left) kms_cursor_crc (cursor-sliding-256x256) [733.080705] Starting subtest: cursor-sliding-256x256 [733.085016] Starting dynamic subtest: pipe-A-HDMI-A-1 [734.934400] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.850s) [734.968968] Starting dynamic subtest: pipe-D-HDMI-A-1 [736.775403] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.814s) [736.776117] Subtest cursor-sliding-256x256: SUCCESS (3.696s) [736.917906] [130/133] (284s left) kms_lease (lease-get) [737.008025] Starting subtest: lease-get [737.009900] Starting dynamic subtest: pipe-A-HDMI-A-1 [737.010583] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.001s) [737.020852] Starting dynamic subtest: pipe-B-HDMI-A-1 [737.021552] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s) [737.030569] Starting dynamic subtest: pipe-C-HDMI-A-1 [737.031256] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.001s) [737.039784] Starting dynamic subtest: pipe-D-HDMI-A-1 [737.040472] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.001s) [737.041135] Subtest lease-get: SUCCESS (0.011s) [737.105757] [131/133] (284s left) kms_color_pipeline (plane-ctm3x4-lut1d) [737.195698] Starting subtest: plane-ctm3x4-lut1d [737.279101] Starting dynamic subtest: pipe-A-plane-0 [737.377858] Dynamic subtest pipe-A-plane-0: SUCCESS (0.099s) [737.395183] Starting dynamic subtest: pipe-A-plane-1 [737.469551] Dynamic subtest pipe-A-plane-1: SUCCESS (0.089s) [737.486691] Starting dynamic subtest: pipe-A-plane-2 [737.562616] Dynamic subtest pipe-A-plane-2: SUCCESS (0.089s) [737.753982] Starting dynamic subtest: pipe-B-plane-0 [737.830284] Dynamic subtest pipe-B-plane-0: SUCCESS (0.090s) [737.845880] Starting dynamic subtest: pipe-B-plane-1 [737.930294] Dynamic subtest pipe-B-plane-1: SUCCESS (0.097s) [737.946012] Starting dynamic subtest: pipe-B-plane-2 [738.024104] Dynamic subtest pipe-B-plane-2: SUCCESS (0.089s) [738.227118] Starting dynamic subtest: pipe-C-plane-0 [738.310900] Dynamic subtest pipe-C-plane-0: SUCCESS (0.091s) [738.324916] Starting dynamic subtest: pipe-C-plane-1 [738.403309] Dynamic subtest pipe-C-plane-1: SUCCESS (0.089s) [738.412881] Starting dynamic subtest: pipe-C-plane-2 [738.502590] Dynamic subtest pipe-C-plane-2: SUCCESS (0.098s) [738.721172] Starting dynamic subtest: pipe-D-plane-0 [738.807533] Dynamic subtest pipe-D-plane-0: SUCCESS (0.099s) [738.821668] Starting dynamic subtest: pipe-D-plane-1 [738.907784] Dynamic subtest pipe-D-plane-1: SUCCESS (0.098s) [738.921651] Starting dynamic subtest: pipe-D-plane-2 [739.007792] Dynamic subtest pipe-D-plane-2: SUCCESS (0.097s) [739.056847] Subtest plane-ctm3x4-lut1d: SUCCESS (1.861s) [739.169968] [132/133] (282s left) gem_pread (snoop) [739.204299] Starting subtest: snoop [740.049682] Subtest snoop: SUCCESS (0.837s) [740.126950] [133/133] (281s left) kms_atomic_transition (modeset-transition-nonblocking-fencing) [740.219321] Starting subtest: modeset-transition-nonblocking-fencing [740.220105] Starting dynamic subtest: 1x-outputs [741.415503] Dynamic subtest 1x-outputs: SUCCESS (1.188s) [741.416494] Subtest modeset-transition-nonblocking-fencing: SUCCESS (1.190s) [741.562098] Closing watchdogs results: parsing output: 0/ for test: kms_big_fb results: parsing output: 1/ for test: gem_lmem_swapping results: parsing output: 2/ for test: kms_plane_scaling results: parsing output: 3/ for test: kms_flip results: parsing output: 4/ for test: kms_flip results: parsing output: 5/ for test: gem_exec_balancer results: parsing output: 6/ for test: kms_big_fb results: parsing output: 7/ for test: kms_cursor_legacy results: parsing output: 8/ for test: kms_frontbuffer_tracking results: parsing output: 9/ for test: kms_cursor_legacy results: parsing output: 10/ for test: kms_chamelium_frames results: parsing output: 11/ for test: gem_ctx_persistence results: parsing output: 12/ for test: perf_pmu results: parsing output: 13/ for test: kms_frontbuffer_tracking results: parsing output: 14/ for test: gen7_exec_parse results: parsing output: 15/ for test: kms_ccs results: parsing output: 16/ for test: syncobj_timeline results: parsing output: 17/ for test: api_intel_bb results: parsing output: 18/ for test: gem_exec_params results: parsing output: 19/ for test: gem_exec_reloc results: parsing output: 20/ for test: gem_render_copy results: parsing output: 21/ for test: gem_exec_params results: parsing output: 22/ for test: i915_selftest results: parsing output: 23/ for test: kms_big_fb results: parsing output: 24/ for test: kms_frontbuffer_tracking results: parsing output: 25/ for test: kms_psr results: parsing output: 26/ for test: kms_psr2_sf results: parsing output: 27/ for test: kms_frontbuffer_tracking results: parsing output: 28/ for test: gem_exec_reloc results: parsing output: 29/ for test: gem_close_race results: parsing output: 30/ for test: perf_pmu results: parsing output: 31/ for test: kms_getfb results: parsing output: 32/ for test: gem_exercise_blt results: parsing output: 33/ for test: kms_prop_blob results: parsing output: 34/ for test: kms_frontbuffer_tracking results: parsing output: 35/ for test: kms_selftest results: parsing output: 36/ for test: kms_frontbuffer_tracking results: parsing output: 37/ for test: gem_exec_flush results: parsing output: 38/ for test: kms_frontbuffer_tracking results: parsing output: 39/ for test: perf_pmu results: parsing output: 40/ for test: prime_mmap results: parsing output: 41/ for test: kms_big_fb results: parsing output: 42/ for test: kms_flip results: parsing output: 43/ for test: kms_psr results: parsing output: 44/ for test: gem_exec_reloc results: parsing output: 45/ for test: kms_frontbuffer_tracking results: parsing output: 46/ for test: kms_content_protection results: parsing output: 47/ for test: gem_exec_schedule results: parsing output: 48/ for test: fbdev results: parsing output: 49/ for test: perf results: parsing output: 50/ for test: kms_ccs results: parsing output: 51/ for test: gem_ctx_shared results: parsing output: 52/ for test: kms_flip_scaled_crc results: parsing output: 53/ for test: kms_flip results: parsing output: 54/ for test: gem_wait results: parsing output: 55/ for test: kms_plane results: parsing output: 56/ for test: gem_eio results: parsing output: 57/ for test: kms_frontbuffer_tracking results: parsing output: 58/ for test: kms_frontbuffer_tracking results: parsing output: 59/ for test: kms_cursor_crc results: parsing output: 60/ for test: kms_busy results: parsing output: 61/ for test: kms_debugfs results: parsing output: 62/ for test: kms_cursor_crc results: parsing output: 63/ for test: kms_rotation_crc results: parsing output: 64/ for test: kms_addfb_basic results: parsing output: 65/ for test: gem_mmap results: parsing output: 66/ for test: gem_userptr_blits results: parsing output: 67/ for test: gem_spin_batch results: parsing output: 68/ for test: gem_render_copy results: parsing output: 69/ for test: gem_exec_balancer results: parsing output: 70/ for test: i915_pm_rpm results: parsing output: 71/ for test: gem_mmap results: parsing output: 72/ for test: kms_vblank results: parsing output: 73/ for test: gem_exec_schedule results: parsing output: 74/ for test: kms_rotation_crc results: parsing output: 75/ for test: kms_psr results: parsing output: 76/ for test: prime_busy results: parsing output: 77/ for test: gem_ctx_persistence results: parsing output: 78/ for test: perf results: parsing output: 79/ for test: kms_cursor_legacy results: parsing output: 80/ for test: gem_exec_params results: parsing output: 81/ for test: kms_pm_backlight results: parsing output: 82/ for test: gem_readwrite results: parsing output: 83/ for test: kms_frontbuffer_tracking results: parsing output: 84/ for test: gem_mmap_wc results: parsing output: 85/ for test: kms_frontbuffer_tracking results: parsing output: 86/ for test: kms_ccs results: parsing output: 87/ for test: gem_exec_whisper results: parsing output: 88/ for test: gem_exec_reloc results: parsing output: 89/ for test: kms_pm_rpm results: parsing output: 90/ for test: kms_ccs results: parsing output: 91/ for test: i915_module_load results: parsing output: 92/ for test: kms_frontbuffer_tracking results: parsing output: 93/ for test: syncobj_timeline results: parsing output: 94/ for test: syncobj_timeline results: parsing output: 95/ for test: gem_exec_fence results: parsing output: 96/ for test: kms_plane_scaling results: parsing output: 97/ for test: kms_plane_alpha_blend results: parsing output: 98/ for test: kms_properties results: parsing output: 99/ for test: kms_invalid_mode results: parsing output: 100/ for test: kms_psr results: parsing output: 101/ for test: syncobj_timeline results: parsing output: 102/ for test: kms_cursor_legacy results: parsing output: 103/ for test: drm_buddy results: parsing output: 104/ for test: syncobj_timeline results: parsing output: 105/ for test: core_auth results: parsing output: 106/ for test: vgem_basic results: parsing output: 107/ for test: gem_eio results: parsing output: 108/ for test: i915_drm_fdinfo results: parsing output: 109/ for test: kms_plane_cursor results: parsing output: 110/ for test: api_intel_allocator results: parsing output: 111/ for test: kms_draw_crc results: parsing output: 112/ for test: gem_set_tiling_vs_gtt results: parsing output: 113/ for test: gem_softpin results: parsing output: 114/ for test: kms_cursor_legacy results: parsing output: 115/ for test: kms_cdclk results: parsing output: 116/ for test: kms_psr results: parsing output: 117/ for test: gem_workarounds results: parsing output: 118/ for test: kms_big_fb results: parsing output: 119/ for test: kms_chamelium_hpd results: parsing output: 120/ for test: gem_create results: parsing output: 121/ for test: vgem_basic results: parsing output: 122/ for test: kms_frontbuffer_tracking results: parsing output: 123/ for test: kms_big_fb results: parsing output: 124/ for test: kms_frontbuffer_tracking results: parsing output: 125/ for test: vgem_basic results: parsing output: 126/ for test: gem_mmap_gtt results: parsing output: 127/ for test: sw_sync results: parsing output: 128/ for test: kms_cursor_crc results: parsing output: 129/ for test: kms_lease results: parsing output: 130/ for test: kms_color_pipeline results: parsing output: 131/ for test: gem_pread results: parsing output: 132/ for test: kms_atomic_transition Done.