[57.580216] Initializing watchdogs [57.580305] /dev/watchdog0 [57.593972] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [57.598205] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [57.600542] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [57.603901] [001/130] (960s left) prime_vgem (coherency-gtt) [57.770834] Starting subtest: coherency-gtt [57.775584] Subtest coherency-gtt: SKIP (0.000s) [57.882802] [FACT prime_vgem (coherency-gtt)] new: kernel.kmod_is_loaded.vgem: true [57.885305] [002/130] (960s left) gem_exec_balancer (individual) [57.957847] Starting subtest: individual [59.951884] Subtest individual: SUCCESS (1.993s) [60.261256] [003/130] (957s left) kms_addfb_basic (clobberred-modifier) [60.322690] Starting subtest: clobberred-modifier [60.327080] Subtest clobberred-modifier: SKIP (0.000s) [60.482992] [004/130] (957s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-factor-0-25) [60.576912] Starting subtest: planes-downscale-factor-0-5-upscale-factor-0-25 [60.579207] Starting dynamic subtest: pipe-A [60.588316] Dynamic subtest pipe-A: SKIP (0.006s) [60.596622] Starting dynamic subtest: pipe-B [60.610793] Dynamic subtest pipe-B: SKIP (0.021s) [60.618259] Starting dynamic subtest: pipe-C [60.632630] Dynamic subtest pipe-C: SKIP (0.022s) [60.640584] Starting dynamic subtest: pipe-D [60.654209] Dynamic subtest pipe-D: SKIP (0.022s) [60.657916] Subtest planes-downscale-factor-0-5-upscale-factor-0-25: SKIP (0.072s) [60.737734] [005/130] (957s left) gem_mmap_gtt (basic-small-bo-tiledy) [60.807343] Subtest basic-small-bo-tiledY: SKIP (0.000s) [60.866953] [006/130] (957s left) kms_big_fb (4-tiled-addfb-size-overflow) [60.980115] Starting subtest: 4-tiled-addfb-size-overflow [60.982086] Subtest 4-tiled-addfb-size-overflow: SUCCESS (0.000s) [61.085625] [007/130] (957s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-fully-sf) [66.162431] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-fully-sf [66.166758] Subtest fbc-pr-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.002s) [67.012679] [008/130] (951s left) kms_writeback (writeback-pixel-formats) [67.119315] Subtest writeback-pixel-formats: SKIP (0.000s) [67.156445] [009/130] (951s left) gem_eio (in-flight-contexts-immediate) [67.347262] Starting subtest: in-flight-contexts-immediate [77.955103] Subtest in-flight-contexts-immediate: SUCCESS (10.608s) [78.137561] [010/130] (940s left) kms_psr (pr-sprite-plane-move) [78.238145] Starting subtest: pr-sprite-plane-move [78.242778] Subtest pr-sprite-plane-move: SKIP (0.000s) [78.305184] [011/130] (940s left) kms_addfb_basic (invalid-get-prop-any) [78.365084] Starting subtest: invalid-get-prop-any [78.367101] Subtest invalid-get-prop-any: SUCCESS (0.000s) [78.521511] [012/130] (939s left) gem_ctx_engines (execute-allforone) [78.596322] Starting subtest: execute-allforone [78.609028] Subtest execute-allforone: SUCCESS (0.013s) [79.960171] [013/130] (938s left) kms_cursor_crc (cursor-offscreen-512x512) [80.200567] Starting subtest: cursor-offscreen-512x512 [80.205074] Subtest cursor-offscreen-512x512: SKIP (0.001s) [80.359611] [014/130] (938s left) kms_psr (psr2-sprite-render) [80.466119] Starting subtest: psr2-sprite-render [80.468481] Starting dynamic subtest: eDP-1 [82.204906] Dynamic subtest eDP-1: SUCCESS (1.737s) [82.207160] Subtest psr2-sprite-render: SUCCESS (1.738s) [83.067662] [015/130] (935s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-pwrite) [83.183164] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-pwrite [86.588308] Subtest fbc-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (3.409s) [86.723387] [016/130] (931s left) kms_flip (blocking-absolute-wf_vblank-interruptible) [86.829035] Starting subtest: blocking-absolute-wf_vblank-interruptible [86.833078] Starting dynamic subtest: A-eDP1 [95.542917] Dynamic subtest A-eDP1: SUCCESS (8.711s) [95.551305] Starting dynamic subtest: B-eDP1 [104.268847] Dynamic subtest B-eDP1: SUCCESS (8.725s) [104.278302] Starting dynamic subtest: C-eDP1 [112.982283] Dynamic subtest C-eDP1: SUCCESS (8.713s) [112.991629] Starting dynamic subtest: D-eDP1 [121.709611] Dynamic subtest D-eDP1: SUCCESS (8.726s) [121.711845] Subtest blocking-absolute-wf_vblank-interruptible: SUCCESS (34.881s) [122.911934] [017/130] (895s left) gem_lmem_swapping (parallel-random-verify) [122.954083] Subtest parallel-random-verify: SKIP (0.000s) [122.986731] [018/130] (895s left) i915_pm_rpm (system-suspend-execbuf) [125.036877] Starting subtest: system-suspend-execbuf [187.000656] Subtest system-suspend-execbuf: SUCCESS (47.088s) [187.367939] [019/130] (846s left) api_intel_bb (intel-bb-blit-y) [187.430808] Starting subtest: intel-bb-blit-y [191.014818] Subtest intel-bb-blit-y: SUCCESS (3.586s) [191.133675] [020/130] (842s left) gem_ctx_persistence (legacy-engines-queued) [191.197146] Starting subtest: legacy-engines-queued [191.199650] Starting dynamic subtest: render [191.307227] Dynamic subtest render: SUCCESS (0.110s) [191.318744] Starting dynamic subtest: bsd1 [192.726122] Dynamic subtest bsd1: SUCCESS (1.416s) [192.738052] Starting dynamic subtest: bsd2 [194.772669] Dynamic subtest bsd2: SUCCESS (2.045s) [194.781976] Starting dynamic subtest: blt [194.812213] Dynamic subtest blt: SUCCESS (0.040s) [194.820792] Starting dynamic subtest: vebox [196.756921] Dynamic subtest vebox: SUCCESS (1.942s) [196.759297] Subtest legacy-engines-queued: SUCCESS (5.560s) [196.842867] [021/130] (836s left) kms_getfb (getfb2-accept-ccs) [196.903764] Starting subtest: getfb2-accept-ccs [196.906259] Subtest getfb2-accept-ccs: SUCCESS (0.000s) [196.994711] [022/130] (836s left) gem_exec_params (invalid-ring) [197.062527] Starting subtest: invalid-ring [197.064981] Subtest invalid-ring: SUCCESS (0.000s) [197.173311] [023/130] (836s left) gem_ctx_param (invalid-param-get) [197.221332] Starting subtest: invalid-param-get [197.223874] Subtest invalid-param-get: SUCCESS (0.001s) [197.329728] [024/130] (836s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted) [197.380120] Starting subtest: etime-multi-wait-all-for-submit-submitted [197.483955] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.103s) [197.558761] [025/130] (836s left) perf_pmu (busy-accuracy-98) [197.600487] Starting subtest: busy-accuracy-98 [197.603023] Starting dynamic subtest: rcs0 [200.645269] Dynamic subtest rcs0: SUCCESS (3.044s) [200.657151] Starting dynamic subtest: bcs0 [203.695493] Dynamic subtest bcs0: SUCCESS (3.050s) [203.704611] Starting dynamic subtest: vcs0 [206.740018] Dynamic subtest vcs0: SUCCESS (3.044s) [206.749191] Starting dynamic subtest: vcs1 [209.781244] Dynamic subtest vcs1: SUCCESS (3.040s) [209.789402] Starting dynamic subtest: vecs0 [212.820151] Dynamic subtest vecs0: SUCCESS (3.039s) [212.828713] Starting dynamic subtest: ccs0 [215.872127] Dynamic subtest ccs0: SUCCESS (3.051s) [215.874542] Subtest busy-accuracy-98: SUCCESS (18.272s) [215.998612] [026/130] (817s left) kms_addfb_basic (addfb25-modifier-no-flag) [216.103571] Starting subtest: addfb25-modifier-no-flag [216.105900] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [216.188895] [027/130] (817s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-move) [216.303792] Starting subtest: fbc-2p-primscrn-cur-indfb-move [216.307853] Subtest fbc-2p-primscrn-cur-indfb-move: SKIP (0.000s) [216.406037] [028/130] (817s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-onoff) [216.506909] Starting subtest: fbc-2p-primscrn-cur-indfb-onoff [216.511092] Subtest fbc-2p-primscrn-cur-indfb-onoff: SKIP (0.000s) [216.620015] [029/130] (817s left) kms_frontbuffer_tracking (psr-rgb565-draw-render) [216.723495] Starting subtest: psr-rgb565-draw-render [221.679824] Subtest psr-rgb565-draw-render: SUCCESS (4.959s) [221.797790] [030/130] (812s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible) [221.893728] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible [221.906597] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.011s) [221.974632] [031/130] (812s left) kms_big_fb (4-tiled-8bpp-rotate-270) [222.079854] Starting subtest: 4-tiled-8bpp-rotate-270 [222.100035] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.020s) [222.224932] [032/130] (811s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling) [222.324445] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling [222.326832] Starting dynamic subtest: pipe-A-default-mode [224.995691] Dynamic subtest pipe-A-default-mode: SUCCESS (2.668s) [224.997832] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.669s) [225.852121] [033/130] (808s left) sw_sync (sync_merge_invalid) [225.889046] Starting subtest: sync_merge_invalid [225.902340] Subtest sync_merge_invalid: SUCCESS (0.014s) [225.976445] [034/130] (808s left) gem_exec_flush (basic-wb-ro-default) [226.041491] Starting subtest: basic-wb-ro-default [231.519664] Subtest basic-wb-ro-default: SUCCESS (5.477s) [231.698175] [035/130] (802s left) gem_mmap_offset (bad-flags) [231.755650] Starting subtest: bad-flags [231.758064] Subtest bad-flags: SUCCESS (0.000s) [231.861644] [036/130] (802s left) gen9_exec_parse (bb-large) [231.927024] Subtest bb-large: SKIP (0.000s) [231.989238] [037/130] (802s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-indfb-draw-mmap-wc) [232.088753] Starting subtest: psr-1p-offscren-pri-indfb-draw-mmap-wc [236.624662] Subtest psr-1p-offscren-pri-indfb-draw-mmap-wc: SUCCESS (4.538s) [236.737490] [038/130] (797s left) kms_psr (fbc-psr2-no-drrs) [236.839677] Starting subtest: fbc-psr2-no-drrs [236.842015] Starting dynamic subtest: eDP-1 [236.846175] Dynamic subtest eDP-1: SKIP (0.000s) [236.850400] Subtest fbc-psr2-no-drrs: SKIP (0.000s) [236.909880] [039/130] (797s left) gem_exec_suspend (basic-s3) [236.986944] Starting subtest: basic-S3 [236.989389] Starting dynamic subtest: smem [256.984756] Dynamic subtest smem: SUCCESS (6.842s) [256.987757] Subtest basic-S3: SUCCESS (6.843s) [257.167275] [040/130] (790s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt) [257.280515] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt [262.524027] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (5.243s) [262.642992] [041/130] (784s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render) [262.739036] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render [262.743050] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s) [262.847528] [042/130] (784s left) kms_cursor_legacy (modeset-atomic-cursor-hotspot) [262.970838] Starting subtest: modeset-atomic-cursor-hotspot [262.974850] Subtest modeset-atomic-cursor-hotspot: SKIP (0.000s) [263.099653] [043/130] (784s left) syncobj_timeline (signal-array) [263.148722] Starting subtest: signal-array [263.151538] Subtest signal-array: SUCCESS (0.001s) [263.252882] [044/130] (784s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt) [263.352229] Starting subtest: fbcpsr-farfromfence-mmap-gtt [263.356255] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s) [263.457197] [045/130] (784s left) fbdev (pan) [263.491999] Starting subtest: pan [263.520741] Subtest pan: SUCCESS (0.032s) [263.584254] [046/130] (784s left) kms_color (ctm-signed) [263.673369] Starting subtest: ctm-signed [263.675253] Starting dynamic subtest: pipe-A-eDP-1 [265.774522] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.098s) [265.785707] Starting dynamic subtest: pipe-B-eDP-1 [268.534584] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.760s) [268.544269] Starting dynamic subtest: pipe-C-eDP-1 [271.135860] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.598s) [271.145375] Starting dynamic subtest: pipe-D-eDP-1 [273.824336] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.690s) [273.826741] Subtest ctm-signed: SUCCESS (10.148s) [274.636331] [047/130] (773s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-blt) [274.747699] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-blt [279.939191] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (5.194s) [280.068791] [048/130] (767s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt) [280.175093] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt [280.179609] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [280.293276] [049/130] (767s left) kms_frontbuffer_tracking (fbcpsr-1p-pri-indfb-multidraw) [280.406071] Starting subtest: fbcpsr-1p-pri-indfb-multidraw [300.450028] Subtest fbcpsr-1p-pri-indfb-multidraw: SUCCESS (20.047s) [300.593382] [050/130] (747s left) kms_chamelium_hpd (hdmi-hpd) [301.000837] Subtest hdmi-hpd: SKIP (0.000s) [301.840641] [051/130] (746s left) tools_test (sysfs_l3_parity) [301.898242] Starting subtest: sysfs_l3_parity [301.977774] Subtest sysfs_l3_parity: SKIP (0.091s) [302.029491] [052/130] (745s left) drm_fdinfo (context-close-stress) [302.072178] Starting subtest: context-close-stress [312.821592] Subtest context-close-stress: SUCCESS (10.747s) [312.972591] [053/130] (735s left) syncobj_basic (bad-destroy) [313.167028] Starting subtest: bad-destroy [313.169332] Subtest bad-destroy: SUCCESS (0.000s) [313.269268] [054/130] (734s left) gem_exec_fence (syncobj-import) [313.760602] Starting subtest: syncobj-import [313.767375] Subtest syncobj-import: SUCCESS (0.007s) [315.046618] [055/130] (733s left) gem_exec_schedule (thriceslice) [315.125435] Starting subtest: thriceslice [315.127499] Starting dynamic subtest: rcs0 [315.172946] Dynamic subtest rcs0: SUCCESS (0.057s) [315.185300] Starting dynamic subtest: bcs0 [315.232043] Dynamic subtest bcs0: SUCCESS (0.057s) [315.243865] Starting dynamic subtest: vcs0 [315.264142] Dynamic subtest vcs0: SUCCESS (0.031s) [315.274137] Starting dynamic subtest: vcs1 [315.293448] Dynamic subtest vcs1: SUCCESS (0.029s) [315.306608] Starting dynamic subtest: vecs0 [315.346211] Dynamic subtest vecs0: SUCCESS (0.052s) [315.354936] Starting dynamic subtest: ccs0 [315.413251] Dynamic subtest ccs0: SUCCESS (0.065s) [315.416028] Subtest thriceslice: SUCCESS (0.298s) [315.712179] [056/130] (732s left) kms_busy (extended-modeset-hang-oldfb) [315.832862] Starting subtest: extended-modeset-hang-oldfb [315.835233] Starting dynamic subtest: pipe-A [327.536550] Dynamic subtest pipe-A: SUCCESS (11.698s) [327.551273] Starting dynamic subtest: pipe-D [339.794043] Dynamic subtest pipe-D: SUCCESS (12.253s) [339.796361] Subtest extended-modeset-hang-oldfb: SUCCESS (23.956s) [340.668736] [057/130] (707s left) kms_cursor_crc (cursor-onscreen-512x512) [340.921178] Starting subtest: cursor-onscreen-512x512 [340.926014] Subtest cursor-onscreen-512x512: SKIP (0.001s) [341.080428] [058/130] (707s left) syncobj_timeline (invalid-query-one-illegal-handle) [341.142925] Starting subtest: invalid-query-one-illegal-handle [341.145310] Subtest invalid-query-one-illegal-handle: SUCCESS (0.000s) [341.237631] [059/130] (706s left) api_intel_bb (reset-bb) [341.296059] Starting subtest: reset-bb [341.298624] Subtest reset-bb: SUCCESS (0.004s) [341.410924] [060/130] (706s left) gem_exec_reloc (basic-write-gtt) [341.482465] Subtest basic-write-gtt: SKIP (0.000s) [341.533249] [061/130] (706s left) kms_psr (fbc-pr-sprite-plane-onoff) [341.637662] Starting subtest: fbc-pr-sprite-plane-onoff [341.641214] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s) [341.729270] [062/130] (706s left) gem_ctx_sseu (engines) [341.789595] Subtest engines: SKIP (0.000s) [341.858943] [063/130] (706s left) gem_ctx_persistence (engines-hostile-preempt) [341.911249] Starting subtest: engines-hostile-preempt [341.913289] Starting dynamic subtest: rcs0 [342.008156] Dynamic subtest rcs0: SUCCESS (0.096s) [342.019807] Starting dynamic subtest: bcs0 [342.081530] Dynamic subtest bcs0: SUCCESS (0.071s) [342.092647] Starting dynamic subtest: vcs0 [343.985986] Dynamic subtest vcs0: SUCCESS (1.901s) [343.996064] Starting dynamic subtest: vcs1 [345.925764] Dynamic subtest vcs1: SUCCESS (1.938s) [345.937535] Starting dynamic subtest: vecs0 [347.957761] Dynamic subtest vecs0: SUCCESS (2.030s) [347.968761] Starting dynamic subtest: ccs0 [348.026580] Dynamic subtest ccs0: SUCCESS (0.068s) [348.029205] Subtest engines-hostile-preempt: SUCCESS (6.115s) [348.102194] [064/130] (700s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs) [348.205867] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs [348.208143] Starting dynamic subtest: pipe-A-eDP-1 [348.232415] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [348.241252] Starting dynamic subtest: pipe-B-eDP-1 [348.263111] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [348.272141] Starting dynamic subtest: pipe-C-eDP-1 [348.294070] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [348.302655] Starting dynamic subtest: pipe-D-eDP-1 [348.325979] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [348.330334] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.005s) [350.342599] [065/130] (698s left) syncobj_timeline (single-wait-available-signaled) [350.395700] Starting subtest: single-wait-available-signaled [350.397992] Subtest single-wait-available-signaled: SUCCESS (0.000s) [350.493285] [066/130] (698s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-msflip-blt) [350.598179] Starting subtest: fbc-2p-scndscrn-shrfb-msflip-blt [350.602116] Subtest fbc-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s) [350.688321] [067/130] (697s left) fbdev (unaligned-write) [350.732337] Starting subtest: unaligned-write [350.837961] Subtest unaligned-write: SUCCESS (0.104s) [350.893619] [068/130] (697s left) gem_mmap_wc (set-cache-level) [350.958968] Subtest set-cache-level: SKIP (0.000s) [351.008819] [069/130] (697s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size) [351.138452] Starting subtest: basic-flip-before-cursor-varying-size [352.056349] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.917s) [352.846951] [070/130] (695s left) gem_eio (in-flight-10ms) [353.059461] Starting subtest: in-flight-10ms [361.775368] Subtest in-flight-10ms: SUCCESS (8.716s) [361.956097] [071/130] (686s left) kms_feature_discovery (chamelium) [362.060867] Starting subtest: chamelium [362.065338] Subtest chamelium: SKIP (0.000s) [362.127691] [072/130] (686s left) kms_pipe_b_c_ivb (pipe-b-double-modeset-then-modeset-pipe-c) [362.194324] Subtest pipe-B-double-modeset-then-modeset-pipe-C: SKIP (0.000s) [362.244237] [073/130] (686s left) kms_plane (planar-pixel-format-settings) [362.343975] Starting subtest: planar-pixel-format-settings [362.372476] Subtest planar-pixel-format-settings: SUCCESS (0.028s) [362.468841] [074/130] (686s left) kms_async_flips (test-cursor-atomic) [362.565762] Starting subtest: test-cursor-atomic [362.569333] Subtest test-cursor-atomic: SKIP (0.000s) [363.777688] [075/130] (685s left) kms_psr (fbc-psr-sprite-mmap-cpu) [363.886149] Starting subtest: fbc-psr-sprite-mmap-cpu [363.888109] Starting dynamic subtest: eDP-1 [363.892277] Dynamic subtest eDP-1: SKIP (0.000s) [363.896517] Subtest fbc-psr-sprite-mmap-cpu: SKIP (0.001s) [363.952031] [076/130] (684s left) syncobj_wait (invalid-single-wait-all-unsubmitted) [364.014837] Starting subtest: invalid-single-wait-all-unsubmitted [364.017094] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s) [364.097607] [077/130] (684s left) gen7_exec_parse (batch-without-end) [364.150391] Subtest batch-without-end: SKIP (0.000s) [364.225620] [078/130] (684s left) kms_pipe_crc_basic (hang-read-crc) [364.321080] Starting subtest: hang-read-crc [364.323394] Starting dynamic subtest: pipe-A-eDP-1 [366.421288] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.099s) [366.430189] Starting dynamic subtest: pipe-B-eDP-1 [369.102365] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.678s) [369.111871] Starting dynamic subtest: pipe-C-eDP-1 [371.714406] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.613s) [371.722980] Starting dynamic subtest: pipe-D-eDP-1 [374.372456] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.654s) [374.374412] Subtest hang-read-crc: SUCCESS (10.049s) [375.210193] [079/130] (673s left) kms_chamelium_color (ctm-0-50) [375.312933] Subtest ctm-0-50: SKIP (0.000s) [375.354250] [080/130] (673s left) gem_exec_fence (submit) [375.541291] Starting subtest: submit [375.545940] Subtest submit: SKIP (0.000s) [377.012268] [081/130] (672s left) kms_ccs (crc-primary-suspend-y-tiled-ccs) [377.107983] Starting subtest: crc-primary-suspend-y-tiled-ccs [377.110331] Starting dynamic subtest: pipe-A-eDP-1 [377.119700] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [377.129879] Starting dynamic subtest: pipe-B-eDP-1 [377.138423] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [377.146991] Starting dynamic subtest: pipe-C-eDP-1 [377.155018] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [377.163335] Starting dynamic subtest: pipe-D-eDP-1 [377.171566] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [377.175477] Subtest crc-primary-suspend-y-tiled-ccs: SKIP (0.004s) [379.262202] [082/130] (669s left) kms_lease (lease-invalid-crtc) [379.366848] Starting subtest: lease-invalid-crtc [379.369072] Starting dynamic subtest: pipe-A-eDP-1 [379.371277] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s) [379.380670] Starting dynamic subtest: pipe-B-eDP-1 [379.382789] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [379.391553] Starting dynamic subtest: pipe-C-eDP-1 [379.393430] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [379.402180] Starting dynamic subtest: pipe-D-eDP-1 [379.404434] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [379.406844] Subtest lease-invalid-crtc: SUCCESS (0.004s) [379.440686] [083/130] (669s left) syncobj_wait (single-wait-for-submit-submitted) [379.501355] Starting subtest: single-wait-for-submit-submitted [379.611642] Subtest single-wait-for-submit-submitted: SUCCESS (0.109s) [379.680921] [084/130] (669s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu) [379.788467] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu [379.792806] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [379.882202] [085/130] (669s left) prime_mmap (test_invalid_sync_flags) [379.944342] Starting subtest: test_invalid_sync_flags [379.946681] Starting dynamic subtest: test_invalid_sync_flags-smem [379.948918] Dynamic subtest test_invalid_sync_flags-smem: SUCCESS (0.000s) [379.951137] Subtest test_invalid_sync_flags: SUCCESS (0.001s) [380.056390] [086/130] (669s left) gem_exec_flush (basic-batch-kernel-default-cmd) [380.120365] Starting subtest: basic-batch-kernel-default-cmd [380.124839] Subtest basic-batch-kernel-default-cmd: SKIP (0.000s) [380.307256] [087/130] (668s left) gem_softpin (evict-snoop) [380.371901] Starting subtest: evict-snoop [380.376671] Subtest evict-snoop: SKIP (0.000s) [380.491969] [088/130] (668s left) kms_rotation_crc (sprite-rotation-270) [380.590966] Starting subtest: sprite-rotation-270 [380.595481] Subtest sprite-rotation-270: SKIP (0.001s) [380.657670] [089/130] (668s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs) [380.765011] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs [380.767132] Starting dynamic subtest: pipe-A-eDP-1 [380.789477] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [380.798932] Starting dynamic subtest: pipe-B-eDP-1 [380.820118] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [380.829087] Starting dynamic subtest: pipe-C-eDP-1 [380.851577] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [380.861063] Starting dynamic subtest: pipe-D-eDP-1 [380.882844] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [380.886935] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.007s) [382.926015] [090/130] (666s left) prime_vgem (fence-wait) [383.004845] Starting subtest: fence-wait [383.007211] Starting dynamic subtest: rcs0 [384.045014] Dynamic subtest rcs0: SUCCESS (1.039s) [384.056392] Starting dynamic subtest: bcs0 [385.104154] Dynamic subtest bcs0: SUCCESS (1.056s) [385.116028] Starting dynamic subtest: vcs0 [386.153032] Dynamic subtest vcs0: SUCCESS (1.048s) [386.164772] Starting dynamic subtest: vcs1 [387.194772] Dynamic subtest vcs1: SUCCESS (1.040s) [387.206726] Starting dynamic subtest: vecs0 [388.239685] Dynamic subtest vecs0: SUCCESS (1.042s) [388.251504] Starting dynamic subtest: ccs0 [389.284382] Dynamic subtest ccs0: SUCCESS (1.042s) [389.287190] Subtest fence-wait: SUCCESS (6.280s) [389.410789] [091/130] (659s left) gem_ctx_param (get-priority-new-ctx) [389.462456] Starting subtest: get-priority-new-ctx [389.464753] Subtest get-priority-new-ctx: SUCCESS (0.001s) [389.554542] [092/130] (659s left) kms_selftest (drm_format_helper) [389.595102] Starting subtest: drm_format_helper [389.603665] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8 [389.727080] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.122s) [389.736819] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332 [389.865031] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.137s) [389.875068] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565 [389.997353] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.132s) [390.007383] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555 [390.084367] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.086s) [390.094963] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555 [390.169057] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.083s) [390.179420] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551 [390.279955] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.109s) [390.289834] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888 [390.405990] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.126s) [390.414832] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888 [390.538197] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.131s) [390.548856] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888 [390.692269] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.152s) [390.701066] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010 [390.800473] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.108s) [390.810659] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010 [390.893518] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.093s) [390.902573] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono [391.014431] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.119s) [391.023144] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab [391.095663] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.081s) [391.104415] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888 [391.230690] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.132s) [391.239824] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888 [391.357244] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.126s) [391.368144] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset [391.498131] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.141s) [391.508841] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_build_fourcc_list [391.631065] Dynamic subtest drm_format_helper_test-drm_test_fb_build_fourcc_list: SUCCESS (0.132s) [391.639902] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy [391.748043] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.115s) [391.750221] Subtest drm_format_helper: SUCCESS (2.154s) [391.926257] [093/130] (657s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-mc-ccs) [391.988292] Starting subtest: y-tiled-ccs-to-yf-tiled-mc-ccs [391.992877] Subtest y-tiled-ccs-to-yf-tiled-mc-ccs: SKIP (0.000s) [392.175838] [094/130] (657s left) kms_vblank (wait-busy) [392.280987] Starting subtest: wait-busy [392.283277] Starting dynamic subtest: pipe-A-eDP-1 [394.170481] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.888s) [394.186200] Starting dynamic subtest: pipe-D-eDP-1 [396.693146] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.520s) [396.695815] Subtest wait-busy: SUCCESS (4.413s) [397.481176] [095/130] (652s left) gem_mmap_gtt (hang) [397.553489] Subtest hang: SKIP (0.000s) [397.629161] [096/130] (651s left) kms_ccs (ccs-on-another-bo-y-tiled-ccs) [397.737323] Starting subtest: ccs-on-another-bo-y-tiled-ccs [397.739756] Starting dynamic subtest: pipe-A-eDP-1 [397.763103] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [397.772401] Starting dynamic subtest: pipe-B-eDP-1 [397.793852] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [397.802619] Starting dynamic subtest: pipe-C-eDP-1 [397.825639] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [397.835901] Starting dynamic subtest: pipe-D-eDP-1 [397.858138] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [397.862299] Subtest ccs-on-another-bo-y-tiled-ccs: SKIP (0.004s) [399.940961] [097/130] (649s left) kms_big_fb (linear-8bpp-rotate-0) [400.051591] Starting subtest: linear-8bpp-rotate-0 [401.240529] Subtest linear-8bpp-rotate-0: SUCCESS (1.190s) [401.396873] [098/130] (648s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip) [401.500221] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip [402.710420] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.211s) [402.863453] [099/130] (646s left) kms_dsc (dsc-fractional-bpp-with-bpc) [402.966537] Starting subtest: dsc-fractional-bpp-with-bpc [402.991426] Subtest dsc-fractional-bpp-with-bpc: SKIP (0.001s) [403.037321] [100/130] (646s left) perf (unprivileged-single-ctx-counters) [403.145937] Starting subtest: unprivileged-single-ctx-counters [403.149439] Subtest unprivileged-single-ctx-counters: SKIP (0.000s) [403.182527] [101/130] (646s left) gem_exec_schedule (preempt-queue) [403.251404] Subtest preempt-queue: SKIP (0.000s) [403.539929] [102/130] (646s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-pwrite) [403.637034] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-pwrite [403.641137] Subtest psr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [403.733771] [103/130] (646s left) gem_exec_params (invalid-fence-in-submit) [403.793301] Starting subtest: invalid-fence-in-submit [403.798521] Subtest invalid-fence-in-submit: SUCCESS (0.005s) [403.891929] [104/130] (645s left) gem_userptr_blits (stress-purge) [403.961077] Starting subtest: stress-purge [409.348996] Subtest stress-purge: SUCCESS (5.389s) [409.502117] [105/130] (640s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-sf) [414.589472] Starting subtest: psr2-cursor-plane-move-continuous-sf [414.591877] Starting dynamic subtest: pipe-A-eDP-1 [425.684124] Dynamic subtest pipe-A-eDP-1: SUCCESS (11.092s) [425.693620] Starting dynamic subtest: pipe-B-eDP-1 [436.712852] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.024s) [436.715438] Subtest psr2-cursor-plane-move-continuous-sf: SUCCESS (22.120s) [437.498669] [106/130] (612s left) i915_selftest (perf) [441.040592] Starting subtest: perf [441.043612] Starting dynamic subtest: engine_cs [445.477751] Dynamic subtest engine_cs: SUCCESS (4.435s) [445.487512] Starting dynamic subtest: request [452.823332] Dynamic subtest request: SUCCESS (7.343s) [452.833544] Starting dynamic subtest: migrate [457.176316] Dynamic subtest migrate: SUCCESS (4.351s) [457.185843] Starting dynamic subtest: region [463.053527] Dynamic subtest region: SUCCESS (5.874s) [463.056103] Subtest perf: SUCCESS (22.010s) [463.080748] [FACT i915_selftest (perf)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [463.081568] [FACT i915_selftest (perf)] deleted: kernel.kmod_is_loaded.i915: true [463.084693] [107/130] (586s left) gem_partial_pwrite_pread (writes-after-reads) [464.448673] Subtest writes-after-reads: SKIP (0.000s) [464.534217] [FACT gem_partial_pwrite_pread (writes-after-reads)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [464.536132] [FACT gem_partial_pwrite_pread (writes-after-reads)] new: kernel.kmod_is_loaded.i915: true [464.539887] [108/130] (585s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc) [464.647150] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc [464.651068] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [464.749890] [109/130] (585s left) kms_invalid_mode (clock-too-high) [464.853213] Starting subtest: clock-too-high [464.855571] Starting dynamic subtest: pipe-A-eDP-1 [464.860077] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [464.869155] Starting dynamic subtest: pipe-B-eDP-1 [464.873286] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [464.881572] Starting dynamic subtest: pipe-C-eDP-1 [464.886135] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [464.894447] Starting dynamic subtest: pipe-D-eDP-1 [464.899513] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [464.903940] Subtest clock-too-high: SKIP (0.004s) [464.939206] [110/130] (585s left) kms_pm_rpm (modeset-lpsp) [467.116378] Starting subtest: modeset-lpsp [468.547481] Subtest modeset-lpsp: SUCCESS (1.434s) [468.640067] [111/130] (581s left) kms_big_fb (yf-tiled-16bpp-rotate-270) [468.768854] Starting subtest: yf-tiled-16bpp-rotate-270 [468.773426] Subtest yf-tiled-16bpp-rotate-270: SKIP (0.000s) [468.878660] [112/130] (581s left) gem_render_copy (mixed-tiled-to-y-tiled-ccs) [468.948386] Starting subtest: mixed-tiled-to-y-tiled-ccs [468.952989] Subtest mixed-tiled-to-y-tiled-ccs: SKIP (0.000s) [469.123970] [113/130] (581s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu) [469.222968] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu [469.226900] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s) [469.338161] [114/130] (580s left) kms_pm_backlight (bad-brightness) [469.439270] Starting subtest: bad-brightness [469.516584] Starting dynamic subtest: eDP-1 [469.832172] Dynamic subtest eDP-1: SUCCESS (0.313s) [469.834713] Subtest bad-brightness: SUCCESS (0.392s) [470.640156] [115/130] (579s left) gem_partial_pwrite_pread (write-display) [470.700419] Subtest write-display: SKIP (0.000s) [470.779006] [116/130] (579s left) gem_ctx_param (invalid-param-set) [470.842617] Starting subtest: invalid-param-set [470.844966] Subtest invalid-param-set: SUCCESS (0.000s) [470.920173] [117/130] (579s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-blt) [471.019417] Starting subtest: psr-2p-primscrn-cur-indfb-draw-blt [471.023598] Subtest psr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [471.124203] [118/130] (579s left) sw_sync (sync_merge) [471.162493] Starting subtest: sync_merge [471.164833] Subtest sync_merge: SUCCESS (0.000s) [471.209837] [119/130] (579s left) kms_chamelium_edid (hdmi-edid-read) [471.636475] Subtest hdmi-edid-read: SKIP (0.000s) [472.430350] [120/130] (578s left) i915_pm_freq_api (freq-reset-multiple) [472.508152] Starting subtest: freq-reset-multiple [472.510705] Starting dynamic subtest: gt0 [479.889363] Dynamic subtest gt0: SUCCESS (7.378s) [479.898020] Starting dynamic subtest: gt1 [486.465141] Dynamic subtest gt1: SUCCESS (6.576s) [486.467952] Subtest freq-reset-multiple: SUCCESS (13.955s) [486.538316] [121/130] (563s left) syncobj_timeline (invalid-signal-one-illegal-handle) [486.595382] Starting subtest: invalid-signal-one-illegal-handle [486.597730] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s) [486.701537] [122/130] (563s left) gem_pxp (create-valid-protected-context) [486.830838] Starting subtest: create-valid-protected-context [486.833248] Subtest create-valid-protected-context: SUCCESS (0.002s) [486.949520] [123/130] (563s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic) [487.076089] Starting subtest: 2x-cursor-vs-flip-atomic [487.080317] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.002s) [487.207862] [124/130] (563s left) gem_exec_whisper (basic-normal-all) [487.272887] Starting subtest: basic-normal-all [489.504166] Subtest basic-normal-all: SUCCESS (2.231s) [489.689647] [125/130] (560s left) gem_mmap (bad-size) [489.757687] Subtest bad-size: SKIP (0.000s) [489.819252] [126/130] (560s left) kms_big_fb (y-tiled-8bpp-rotate-90) [489.934664] Starting subtest: y-tiled-8bpp-rotate-90 [489.939088] Subtest y-tiled-8bpp-rotate-90: SKIP (0.000s) [490.049365] [127/130] (560s left) perf_pmu (module-unload) [490.142850] Starting subtest: module-unload [535.881237] Subtest module-unload: SUCCESS (45.740s) [535.904771] [FACT perf_pmu (module-unload)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [535.905500] [FACT perf_pmu (module-unload)] deleted: kernel.kmod_is_loaded.i915: true [535.908628] [128/130] (514s left) gem_fenced_exec_thrash (no-spare-fences-busy) [537.250059] Subtest no-spare-fences-busy: SKIP (0.000s) [537.325927] [FACT gem_fenced_exec_thrash (no-spare-fences-busy)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [537.327841] [FACT gem_fenced_exec_thrash (no-spare-fences-busy)] new: kernel.kmod_is_loaded.i915: true [537.331753] [129/130] (513s left) kms_psr2_sf (fbc-pr-plane-move-sf-dmg-area) [542.415303] Starting subtest: fbc-pr-plane-move-sf-dmg-area [542.419899] Subtest fbc-pr-plane-move-sf-dmg-area: SKIP (0.003s) [543.437848] [130/130] (507s left) kms_cursor_crc (cursor-rapid-movement-64x21) [543.617861] Starting subtest: cursor-rapid-movement-64x21 [543.658978] Subtest cursor-rapid-movement-64x21: SKIP (0.035s) [543.885062] Closing watchdogs Done.