[56.593450] Initializing watchdogs [56.593573] /dev/watchdog0 [56.607885] [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] [56.612085] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [56.614591] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [56.618015] [001/134] (960s left) kms_plane_alpha_blend (constant-alpha-min) [56.737930] Starting subtest: constant-alpha-min [57.019404] Starting dynamic subtest: pipe-A-eDP-1 [57.755634] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.742s) [57.763911] Starting dynamic subtest: pipe-D-eDP-1 [59.195185] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.448s) [59.197990] Subtest constant-alpha-min: SUCCESS (2.478s) [60.000199] [002/134] (957s left) kms_plane (plane-position-covered) [60.091499] Starting subtest: plane-position-covered [60.599715] Starting dynamic subtest: pipe-A-plane-1 [61.841623] Dynamic subtest pipe-A-plane-1: SUCCESS (1.247s) [61.850339] Starting dynamic subtest: pipe-A-plane-2 [63.085032] Dynamic subtest pipe-A-plane-2: SUCCESS (1.249s) [63.093756] Starting dynamic subtest: pipe-A-plane-3 [64.348737] Dynamic subtest pipe-A-plane-3: SUCCESS (1.265s) [64.360437] Starting dynamic subtest: pipe-A-plane-4 [65.636870] Dynamic subtest pipe-A-plane-4: SUCCESS (1.294s) [65.646538] Starting dynamic subtest: pipe-A-plane-5 [65.663034] Dynamic subtest pipe-A-plane-5: SUCCESS (0.024s) [66.778185] Starting dynamic subtest: pipe-B-plane-1 [68.036798] Dynamic subtest pipe-B-plane-1: SUCCESS (1.267s) [68.045133] Starting dynamic subtest: pipe-B-plane-2 [69.350478] Dynamic subtest pipe-B-plane-2: SUCCESS (1.316s) [69.359838] Starting dynamic subtest: pipe-B-plane-3 [70.663336] Dynamic subtest pipe-B-plane-3: SUCCESS (1.313s) [70.672067] Starting dynamic subtest: pipe-B-plane-4 [71.900342] Dynamic subtest pipe-B-plane-4: SUCCESS (1.239s) [71.907982] Starting dynamic subtest: pipe-B-plane-5 [71.925965] Dynamic subtest pipe-B-plane-5: SUCCESS (0.024s) [71.928534] Subtest plane-position-covered: SUCCESS (11.870s) [72.710706] [003/134] (944s left) gem_mmap_gtt (basic-wc) [72.787319] Subtest basic-wc: SKIP (0.000s) [72.853017] [004/134] (944s left) kms_flip (2x-flip-vs-panning) [72.953581] Starting subtest: 2x-flip-vs-panning [72.963499] Subtest 2x-flip-vs-panning: SKIP (0.012s) [73.085010] [005/134] (944s left) syncobj_wait (multi-wait-for-submit-unsubmitted-signaled) [73.151395] Starting subtest: multi-wait-for-submit-unsubmitted-signaled [73.153675] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.000s) [73.279644] [006/134] (944s left) gem_vm_create (invalid-destroy) [73.332356] Starting subtest: invalid-destroy [73.334720] Subtest invalid-destroy: SUCCESS (0.002s) [73.458948] [007/134] (943s left) kms_async_flips (async-flip-dpms) [73.553523] Starting subtest: async-flip-dpms [73.932525] Starting dynamic subtest: pipe-A-eDP-1 [77.727093] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.795s) [78.116870] Starting dynamic subtest: pipe-B-eDP-1 [80.880054] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.770s) [81.256771] Starting dynamic subtest: pipe-C-eDP-1 [84.052511] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.801s) [84.453910] Starting dynamic subtest: pipe-D-eDP-1 [87.221233] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.784s) [87.223826] Subtest async-flip-dpms: SUCCESS (13.671s) [88.413207] [008/134] (928s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-signaled) [88.480321] Starting subtest: etime-multi-wait-all-available-unsubmitted-signaled [88.586118] Subtest etime-multi-wait-all-available-unsubmitted-signaled: SUCCESS (0.104s) [88.672552] [009/134] (928s left) gem_pxp (fail-invalid-protected-context) [88.805787] Starting subtest: fail-invalid-protected-context [88.808319] Subtest fail-invalid-protected-context: SUCCESS (0.000s) [88.919668] [010/134] (928s left) device_reset (unbind-reset-rebind) [88.965069] Starting subtest: unbind-reset-rebind [93.591838] Subtest unbind-reset-rebind: SUCCESS (4.624s) [93.631315] [011/134] (923s left) gem_mmap_gtt (cpuset-basic-small-copy) [93.693046] Subtest cpuset-basic-small-copy: SKIP (0.000s) [93.751986] [012/134] (923s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc) [93.850922] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs-cc [93.853257] Starting dynamic subtest: pipe-A-eDP-1 [93.873212] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.002s) [93.881831] Starting dynamic subtest: pipe-B-eDP-1 [93.901618] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [93.908088] Starting dynamic subtest: pipe-C-eDP-1 [93.927072] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [93.933422] Starting dynamic subtest: pipe-D-eDP-1 [93.952237] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [93.954117] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.011s) [96.148988] [013/134] (921s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic) [96.279086] Starting subtest: 2x-flip-vs-cursor-atomic [96.283371] Subtest 2x-flip-vs-cursor-atomic: SKIP (0.001s) [96.442714] [014/134] (921s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt) [96.551794] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt [100.983509] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.434s) [102.132252] [015/134] (915s left) kms_atomic (plane-invalid-params-fence) [102.234146] Starting subtest: plane-invalid-params-fence [102.236550] Starting dynamic subtest: pipe-A-eDP-1 [102.621314] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.388s) [102.623503] Subtest plane-invalid-params-fence: SUCCESS (0.389s) [103.465339] [016/134] (914s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-pwrite) [103.573609] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-pwrite [109.690066] Subtest fbc-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (6.119s) [110.853191] [017/134] (906s left) i915_drm_fdinfo (virtual-idle) [110.897065] Starting subtest: virtual-idle [113.976437] Subtest virtual-idle: SUCCESS (3.079s) [114.064896] [018/134] (903s left) gem_exec_params (invalid-bsd2-flag-on-vebox) [114.146862] Starting subtest: invalid-bsd2-flag-on-vebox [114.149083] Subtest invalid-bsd2-flag-on-vebox: SUCCESS (0.000s) [114.281347] [019/134] (903s left) kms_frontbuffer_tracking (psr-rgb101010-draw-render) [114.387328] Starting subtest: psr-rgb101010-draw-render [121.883970] Subtest psr-rgb101010-draw-render: SUCCESS (7.498s) [122.041028] [020/134] (895s left) syncobj_timeline (transfer-timeline-point) [122.103139] Starting subtest: transfer-timeline-point [122.104913] Subtest transfer-timeline-point: SUCCESS (0.000s) [122.214328] [021/134] (895s left) gem_exec_whisper (basic-normal) [122.281895] Starting subtest: basic-normal [126.051538] Subtest basic-normal: SUCCESS (3.767s) [126.246125] [022/134] (891s left) vgem_basic (dmabuf-fence) [126.337297] Starting subtest: dmabuf-fence [126.339232] Subtest dmabuf-fence: SUCCESS (0.002s) [126.411139] [FACT vgem_basic (dmabuf-fence)] new: kernel.kmod_is_loaded.vgem: true [126.414298] [023/134] (891s left) kms_pm_rpm (legacy-planes-dpms) [127.948540] Starting subtest: legacy-planes-dpms [127.950690] Starting dynamic subtest: plane-64 [136.565633] Dynamic subtest plane-64: SUCCESS (8.618s) [136.577106] Starting dynamic subtest: plane-94 [144.882382] Dynamic subtest plane-94: SUCCESS (8.315s) [144.893545] Starting dynamic subtest: plane-124 [153.173618] Dynamic subtest plane-124: SUCCESS (8.289s) [153.184570] Starting dynamic subtest: plane-134 [161.489033] Dynamic subtest plane-134: SUCCESS (8.313s) [161.491520] Subtest legacy-planes-dpms: SUCCESS (33.543s) [161.883285] [024/134] (856s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-factor-0-25) [161.980121] Starting subtest: planes-downscale-factor-0-5-upscale-factor-0-25 [161.982413] Starting dynamic subtest: pipe-A [161.999703] Dynamic subtest pipe-A: SKIP (0.017s) [162.008477] Starting dynamic subtest: pipe-B [162.036533] Dynamic subtest pipe-B: SKIP (0.034s) [162.044761] Starting dynamic subtest: pipe-C [162.068822] Dynamic subtest pipe-C: SKIP (0.034s) [162.076840] Starting dynamic subtest: pipe-D [162.099274] Dynamic subtest pipe-D: SKIP (0.030s) [162.102937] Subtest planes-downscale-factor-0-5-upscale-factor-0-25: SKIP (0.117s) [162.220190] [025/134] (855s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt) [162.322593] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt [162.327061] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s) [162.439829] [026/134] (855s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-pgflip-blt) [162.545553] Starting subtest: fbc-2p-scndscrn-shrfb-pgflip-blt [162.549937] Subtest fbc-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [162.674838] [027/134] (855s left) sysfs_preempt_timeout (timeout) [162.746764] Starting subtest: timeout [162.749028] Starting dynamic subtest: vecs0 [171.923068] Dynamic subtest vecs0: SUCCESS (9.172s) [171.934562] Starting dynamic subtest: ccs0 [173.325552] Dynamic subtest ccs0: SUCCESS (1.402s) [173.336183] Starting dynamic subtest: vcs0 [182.949524] Dynamic subtest vcs0: SUCCESS (9.621s) [182.961082] Starting dynamic subtest: bcs0 [184.344106] Dynamic subtest bcs0: SUCCESS (1.394s) [184.354534] Starting dynamic subtest: rcs0 [185.719974] Dynamic subtest rcs0: SUCCESS (1.373s) [185.730925] Starting dynamic subtest: vcs1 [194.920052] Dynamic subtest vcs1: SUCCESS (9.196s) [194.922686] Subtest timeout: SUCCESS (32.169s) [195.006343] [028/134] (823s left) kms_cursor_crc (cursor-random-128x42) [195.253652] Starting subtest: cursor-random-128x42 [195.303246] Subtest cursor-random-128x42: SKIP (0.043s) [195.561909] [029/134] (822s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier-source-clamping) [195.650202] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier-source-clamping [195.677278] Starting dynamic subtest: pipe-A-plane-0 [195.681737] Dynamic subtest pipe-A-plane-0: SKIP (0.000s) [195.692532] Starting dynamic subtest: pipe-A-plane-3 [195.696950] Dynamic subtest pipe-A-plane-3: SKIP (0.000s) [195.705269] Starting dynamic subtest: pipe-A-plane-5 [195.709801] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [196.747246] Starting dynamic subtest: pipe-B-plane-0 [196.751522] Dynamic subtest pipe-B-plane-0: SKIP (0.000s) [196.759440] Starting dynamic subtest: pipe-B-plane-3 [196.763836] Dynamic subtest pipe-B-plane-3: SKIP (0.000s) [196.771628] Starting dynamic subtest: pipe-B-plane-5 [196.775809] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [197.062718] Subtest pixel-format-4-tiled-bmg-ccs-modifier-source-clamping: SKIP (1.411s) [197.933173] [030/134] (820s left) perf_pmu (semaphore-busy) [197.974825] Starting subtest: semaphore-busy [197.976749] Starting dynamic subtest: rcs0 [199.645187] Dynamic subtest rcs0: SUCCESS (1.667s) [199.656355] Starting dynamic subtest: bcs0 [201.276806] Dynamic subtest bcs0: SUCCESS (1.629s) [201.287875] Starting dynamic subtest: vcs0 [205.392940] Dynamic subtest vcs0: SUCCESS (4.113s) [205.403927] Starting dynamic subtest: vcs1 [211.410067] Dynamic subtest vcs1: SUCCESS (6.013s) [211.420803] Starting dynamic subtest: vecs0 [217.425478] Dynamic subtest vecs0: SUCCESS (6.014s) [217.436498] Starting dynamic subtest: ccs0 [220.498346] Dynamic subtest ccs0: SUCCESS (3.070s) [220.501052] Subtest semaphore-busy: SUCCESS (22.521s) [220.626659] [031/134] (797s left) kms_flip (2x-flip-vs-absolute-wf_vblank) [220.734396] Starting subtest: 2x-flip-vs-absolute-wf_vblank [220.743341] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.010s) [220.882647] [032/134] (797s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-pgflip-blt) [220.982227] Starting subtest: fbcpsr-2p-primscrn-shrfb-pgflip-blt [220.986538] Subtest fbcpsr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [221.098797] [033/134] (797s left) gem_readwrite (beyond-eob) [221.144606] Subtest beyond-EOB: SKIP (0.000s) [221.216547] [034/134] (797s left) kms_frontbuffer_tracking (fbc-abgr161616f-draw-mmap-gtt) [221.313455] Starting subtest: fbc-abgr161616f-draw-mmap-gtt [221.318094] Subtest fbc-abgr161616f-draw-mmap-gtt: SKIP (0.000s) [221.443130] [035/134] (797s left) kms_vblank (ts-continuation-modeset-hang) [221.542045] Starting subtest: ts-continuation-modeset-hang [221.544073] Starting dynamic subtest: pipe-A-eDP-1 [247.633682] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.089s) [247.648854] Starting dynamic subtest: pipe-D-eDP-1 [262.683438] Dynamic subtest pipe-D-eDP-1: SUCCESS (15.047s) [262.685884] Subtest ts-continuation-modeset-hang: SUCCESS (41.141s) [263.565772] [036/134] (754s left) gem_ctx_shared (q-independent) [263.627065] Starting subtest: Q-independent [263.629174] Starting dynamic subtest: rcs0 [263.704854] Dynamic subtest rcs0: SUCCESS (0.077s) [263.717416] Starting dynamic subtest: vcs0 [263.747786] Dynamic subtest vcs0: SUCCESS (0.042s) [263.760852] Starting dynamic subtest: vcs1 [263.790319] Dynamic subtest vcs1: SUCCESS (0.042s) [263.803445] Starting dynamic subtest: vecs0 [263.839588] Dynamic subtest vecs0: SUCCESS (0.047s) [263.848017] Starting dynamic subtest: ccs0 [263.886834] Dynamic subtest ccs0: SUCCESS (0.049s) [263.889239] Subtest Q-independent: SUCCESS (0.260s) [265.057414] [037/134] (753s left) gem_exec_whisper (basic-queues-forked) [265.131904] Starting subtest: basic-queues-forked [288.108889] Subtest basic-queues-forked: SUCCESS (22.972s) [288.304346] [038/134] (730s left) kms_rmfb (close-fd) [288.402322] Starting subtest: close-fd [288.404570] Starting dynamic subtest: pipe-A-eDP-1 [288.513327] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.109s) [288.522460] Starting dynamic subtest: pipe-B-eDP-1 [289.717537] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.200s) [289.727064] Starting dynamic subtest: pipe-C-eDP-1 [290.850914] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.130s) [290.859559] Starting dynamic subtest: pipe-D-eDP-1 [291.979013] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.127s) [291.981313] Subtest close-fd: SUCCESS (3.575s) [293.204912] [039/134] (725s left) kms_big_fb (4-tiled-addfb) [293.309930] Starting subtest: 4-tiled-addfb [293.312261] Subtest 4-tiled-addfb: SUCCESS (0.000s) [293.444602] [040/134] (725s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-pgflip-blt) [293.541316] Starting subtest: fbcpsr-1p-primscrn-shrfb-pgflip-blt [300.844351] Subtest fbcpsr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.304s) [301.002912] [041/134] (717s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-fully-sf) [306.031070] Starting subtest: pr-cursor-plane-move-continuous-exceed-fully-sf [306.035674] Subtest pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.002s) [306.885972] [042/134] (711s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip) [306.989133] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip [307.624286] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.637s) [307.843270] [043/134] (710s left) gem_ctx_param (invalid-size-set) [307.890772] Starting subtest: invalid-size-set [307.893107] Subtest invalid-size-set: SUCCESS (0.001s) [308.005872] [044/134] (710s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move) [308.102937] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move [308.107047] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s) [308.229414] [045/134] (710s left) kms_cursor_legacy (flip-vs-cursor-crc-atomic) [308.350807] Starting subtest: flip-vs-cursor-crc-atomic [308.983418] Subtest flip-vs-cursor-crc-atomic: SUCCESS (0.635s) [309.828663] [046/134] (709s left) sw_sync (alloc_fence) [309.863190] Starting subtest: alloc_fence [309.865269] Subtest alloc_fence: SUCCESS (0.000s) [309.928622] [047/134] (709s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc) [310.032423] Starting subtest: fbcpsr-rgb565-draw-mmap-wc [316.763342] Subtest fbcpsr-rgb565-draw-mmap-wc: SUCCESS (6.732s) [316.931791] [048/134] (702s left) gem_partial_pwrite_pread (reads-snoop) [317.003484] Subtest reads-snoop: SKIP (0.000s) [317.094746] [049/134] (702s left) gem_exec_schedule (u-semaphore-codependency) [317.169798] Starting subtest: u-semaphore-codependency [317.172891] Subtest u-semaphore-codependency: SUCCESS (0.012s) [317.544349] [050/134] (701s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-downscaling) [317.635074] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-downscaling [317.637314] Starting dynamic subtest: pipe-A-default-mode [317.925842] Dynamic subtest pipe-A-default-mode: SKIP (0.287s) [317.930417] Subtest flip-64bpp-yftile-to-16bpp-yftile-downscaling: SKIP (0.289s) [318.764238] [051/134] (700s left) gem_ctx_persistence (engines-persistence) [318.824333] Starting subtest: engines-persistence [318.826794] Starting dynamic subtest: rcs0 [319.660266] Dynamic subtest rcs0: SUCCESS (0.835s) [319.673083] Starting dynamic subtest: bcs0 [320.494785] Dynamic subtest bcs0: SUCCESS (0.833s) [320.506063] Starting dynamic subtest: vcs0 [321.334967] Dynamic subtest vcs0: SUCCESS (0.838s) [321.346619] Starting dynamic subtest: vcs1 [322.114324] Dynamic subtest vcs1: SUCCESS (0.777s) [322.125614] Starting dynamic subtest: vecs0 [322.983938] Dynamic subtest vecs0: SUCCESS (0.868s) [322.995851] Starting dynamic subtest: ccs0 [323.753979] Dynamic subtest ccs0: SUCCESS (0.768s) [323.756810] Subtest engines-persistence: SUCCESS (4.931s) [323.850372] [052/134] (695s left) syncobj_timeline (reset-during-wait-for-submit) [323.902364] Starting subtest: reset-during-wait-for-submit [324.005478] Subtest reset-during-wait-for-submit: SUCCESS (0.102s) [324.094034] [053/134] (695s left) gem_ctx_bad_destroy (invalid-ctx) [324.145692] Starting subtest: invalid-ctx [324.148219] Subtest invalid-ctx: SUCCESS (0.000s) [324.236040] [054/134] (695s left) kms_psr (fbc-pr-cursor-mmap-cpu) [324.334947] Starting subtest: fbc-pr-cursor-mmap-cpu [324.339291] Subtest fbc-pr-cursor-mmap-cpu: SKIP (0.000s) [324.415840] [055/134] (694s left) gem_exec_params (rs-invalid) [324.475384] Starting subtest: rs-invalid [324.481290] Subtest rs-invalid: SUCCESS (0.003s) [324.634969] [056/134] (694s left) kms_cursor_legacy (cursor-vs-flip-toggle) [324.760059] Starting subtest: cursor-vs-flip-toggle [355.466061] Subtest cursor-vs-flip-toggle: SUCCESS (30.705s) [356.298112] [057/134] (663s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-gtt) [356.400366] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-gtt [356.404741] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [356.534234] [058/134] (662s left) gem_fence_thrash (bo-write-verify-x) [356.569018] Starting subtest: bo-write-verify-x [356.600901] Subtest bo-write-verify-x: SKIP (0.027s) [356.667119] [059/134] (662s left) kms_big_fb (y-tiled-addfb-size-offset-overflow) [356.765043] Starting subtest: y-tiled-addfb-size-offset-overflow [356.769562] Subtest y-tiled-addfb-size-offset-overflow: SKIP (0.000s) [356.882028] [060/134] (662s left) kms_cursor_edge_walk (128x128-right-edge) [356.963927] Starting subtest: 128x128-right-edge [356.966130] Starting dynamic subtest: pipe-A-eDP-1 [360.447593] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.484s) [360.456810] Starting dynamic subtest: pipe-D-eDP-1 [363.588973] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.138s) [363.590926] Subtest 128x128-right-edge: SUCCESS (6.625s) [364.402033] [061/134] (655s left) prime_vgem (shrink) [364.495573] Starting subtest: shrink [364.517367] Subtest shrink: SUCCESS (0.022s) [364.650395] [062/134] (654s left) kms_flip (modeset-vs-vblank-race-interruptible) [364.752955] Starting subtest: modeset-vs-vblank-race-interruptible [364.755209] Starting dynamic subtest: A-eDP1 [369.438473] Dynamic subtest A-eDP1: SUCCESS (4.684s) [369.449554] Starting dynamic subtest: B-eDP1 [374.055161] Dynamic subtest B-eDP1: SUCCESS (4.614s) [374.066931] Starting dynamic subtest: C-eDP1 [378.579948] Dynamic subtest C-eDP1: SUCCESS (4.523s) [378.588358] Starting dynamic subtest: D-eDP1 [383.109555] Dynamic subtest D-eDP1: SUCCESS (4.528s) [383.111863] Subtest modeset-vs-vblank-race-interruptible: SUCCESS (18.359s) [384.287136] [063/134] (635s left) gem_exec_reloc (basic-cpu-noreloc) [384.345442] Subtest basic-cpu-noreloc: SKIP (0.000s) [384.427790] [064/134] (635s left) kms_chamelium_hpd (dp-hpd-storm) [384.816009] Subtest dp-hpd-storm: SKIP (0.000s) [385.589788] [065/134] (634s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-mc-ccs) [385.678183] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-mc-ccs [385.680396] Starting dynamic subtest: pipe-A-eDP-1 [385.703869] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [385.715386] Starting dynamic subtest: pipe-B-eDP-1 [385.737720] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [385.747060] Starting dynamic subtest: pipe-C-eDP-1 [385.769761] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [385.779735] Starting dynamic subtest: pipe-D-eDP-1 [385.802058] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [385.806620] Subtest crc-primary-rotation-180-4-tiled-dg2-mc-ccs: SKIP (0.005s) [387.996124] [066/134] (631s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-move) [388.093914] Starting subtest: fbc-1p-primscrn-cur-indfb-move [392.151239] Subtest fbc-1p-primscrn-cur-indfb-move: SUCCESS (4.060s) [393.294849] [067/134] (626s left) syncobj_timeline (etime-single-wait-submitted) [393.355578] Starting subtest: etime-single-wait-submitted [393.457472] Subtest etime-single-wait-submitted: SUCCESS (0.102s) [393.557084] [068/134] (626s left) syncobj_wait (reset-multiple-signaled) [393.604531] Starting subtest: reset-multiple-signaled [393.606504] Subtest reset-multiple-signaled: SUCCESS (0.000s) [393.737143] [069/134] (626s left) syncobj_wait (single-wait-for-submit-submitted) [393.810127] Starting subtest: single-wait-for-submit-submitted [393.914229] Subtest single-wait-for-submit-submitted: SUCCESS (0.103s) [394.000450] [070/134] (625s left) gen9_exec_parse (shadow-peek) [394.065730] Subtest shadow-peek: SKIP (0.000s) [394.162607] [071/134] (625s left) perf (rc6-disable) [394.287711] Starting subtest: rc6-disable [394.469692] Subtest rc6-disable: SUCCESS (0.182s) [394.516741] [072/134] (625s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu) [394.616534] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu [394.620817] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [394.741038] [073/134] (625s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc) [394.844082] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc [394.848681] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [394.979344] [074/134] (625s left) gem_ctx_param (root-set) [395.033584] Starting subtest: root-set [395.035620] Subtest root-set: SUCCESS (0.001s) [395.174950] [075/134] (625s left) api_intel_bb (intel-bb-blit-x) [395.247232] Starting subtest: intel-bb-blit-x [398.870813] Subtest intel-bb-blit-x: SUCCESS (3.623s) [399.008538] [076/134] (621s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24) [399.121173] Starting subtest: compare-crc-sanitycheck-xr24 [399.123405] Starting dynamic subtest: pipe-A-eDP-1 [399.751661] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.631s) [399.765116] Starting dynamic subtest: pipe-B-eDP-1 [401.061750] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.305s) [401.079368] Starting dynamic subtest: pipe-C-eDP-1 [402.324843] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.264s) [402.334264] Starting dynamic subtest: pipe-D-eDP-1 [403.534184] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.206s) [403.536513] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.413s) [404.397323] [077/134] (615s left) kms_cdclk (mode-transition-all-outputs) [404.491626] Starting subtest: mode-transition-all-outputs [404.782611] Subtest mode-transition-all-outputs: SKIP (0.289s) [405.642121] [078/134] (614s left) gem_exec_reloc (basic-gtt-read-noreloc) [405.693820] Subtest basic-gtt-read-noreloc: SKIP (0.000s) [405.784914] [079/134] (614s left) kms_psr (fbc-pr-sprite-mmap-cpu) [405.879826] Starting subtest: fbc-pr-sprite-mmap-cpu [405.884227] Subtest fbc-pr-sprite-mmap-cpu: SKIP (0.000s) [405.976954] [080/134] (614s left) kms_cursor_legacy (short-busy-flip-before-cursor-toggle) [406.087861] Starting subtest: short-busy-flip-before-cursor-toggle [406.092097] Subtest short-busy-flip-before-cursor-toggle: SKIP (0.000s) [406.247298] [081/134] (614s left) kms_frontbuffer_tracking (psr-rgb565-draw-render) [406.330236] Starting subtest: psr-rgb565-draw-render [413.343328] Subtest psr-rgb565-draw-render: SUCCESS (7.017s) [413.499984] [082/134] (606s left) kms_cursor_crc (cursor-onscreen-64x64) [413.687227] Starting subtest: cursor-onscreen-64x64 [413.689474] Starting dynamic subtest: pipe-A-eDP-1 [415.784214] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.096s) [415.814133] Starting dynamic subtest: pipe-D-eDP-1 [418.529659] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.721s) [418.531931] Subtest cursor-onscreen-64x64: SUCCESS (4.842s) [419.338669] [083/134] (601s left) gem_exec_fence (basic-await) [419.522779] Starting subtest: basic-await [419.524884] Starting dynamic subtest: rcs0 [419.593939] Dynamic subtest rcs0: SUCCESS (0.074s) [419.607091] Starting dynamic subtest: bcs0 [419.664602] Dynamic subtest bcs0: SUCCESS (0.070s) [419.675517] Starting dynamic subtest: vcs0 [419.736755] Dynamic subtest vcs0: SUCCESS (0.070s) [419.748754] Starting dynamic subtest: vcs1 [419.807872] Dynamic subtest vcs1: SUCCESS (0.070s) [419.819772] Starting dynamic subtest: vecs0 [419.879845] Dynamic subtest vecs0: SUCCESS (0.070s) [419.893061] Starting dynamic subtest: ccs0 [419.950715] Dynamic subtest ccs0: SUCCESS (0.069s) [419.953075] Subtest basic-await: SUCCESS (0.432s) [422.003416] [084/134] (598s left) gem_pxp (create-regular-context-1) [422.126984] Starting subtest: create-regular-context-1 [422.129857] Subtest create-regular-context-1: SUCCESS (0.002s) [422.269986] [085/134] (598s left) kms_draw_crc (draw-method-pwrite) [422.371088] Starting subtest: draw-method-pwrite [422.372964] Starting dynamic subtest: xrgb8888-untiled [422.901867] Dynamic subtest xrgb8888-untiled: SUCCESS (0.532s) [422.910167] Starting dynamic subtest: rgb565-untiled [423.324199] Dynamic subtest rgb565-untiled: SUCCESS (0.421s) [423.333413] Starting dynamic subtest: xrgb2101010-untiled [423.868446] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.544s) [423.877580] Starting dynamic subtest: xbgr16161616f-untiled [424.580420] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.710s) [424.588909] Starting dynamic subtest: xrgb8888-xtiled [426.279861] Dynamic subtest xrgb8888-xtiled: SUCCESS (1.699s) [426.288721] Starting dynamic subtest: rgb565-xtiled [427.302093] Dynamic subtest rgb565-xtiled: SUCCESS (1.021s) [427.311311] Starting dynamic subtest: xrgb2101010-xtiled [428.970577] Dynamic subtest xrgb2101010-xtiled: SUCCESS (1.664s) [428.979544] Starting dynamic subtest: xbgr16161616f-xtiled [432.169148] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (3.199s) [432.178372] Starting dynamic subtest: xrgb8888-4tiled [433.213159] Dynamic subtest xrgb8888-4tiled: SUCCESS (1.043s) [433.222798] Starting dynamic subtest: rgb565-4tiled [433.735583] Dynamic subtest rgb565-4tiled: SUCCESS (0.521s) [433.744921] Starting dynamic subtest: xrgb2101010-4tiled [434.757931] Dynamic subtest xrgb2101010-4tiled: SUCCESS (1.020s) [434.767069] Starting dynamic subtest: xbgr16161616f-4tiled [437.591391] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (2.833s) [437.593661] Subtest draw-method-pwrite: SUCCESS (15.222s) [437.718889] [086/134] (582s left) gem_sync (basic-store-each) [437.794291] Starting subtest: basic-store-each [440.249251] Subtest basic-store-each: SUCCESS (2.465s) [440.445157] [087/134] (580s left) gen7_exec_parse (chained-batch) [440.498636] Subtest chained-batch: SKIP (0.000s) [440.582481] [088/134] (580s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs) [440.681872] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs [440.684130] Starting dynamic subtest: pipe-A-eDP-1 [440.741581] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [440.750485] Starting dynamic subtest: pipe-B-eDP-1 [440.808305] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [440.818791] Starting dynamic subtest: pipe-C-eDP-1 [440.878390] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [440.889056] Starting dynamic subtest: pipe-D-eDP-1 [440.946736] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [440.951222] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.009s) [442.906026] [089/134] (577s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite) [443.016775] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite [449.820372] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.807s) [449.960866] [090/134] (570s left) kms_psr (fbc-psr-sprite-blt) [450.054903] Starting subtest: fbc-psr-sprite-blt [450.057217] Starting dynamic subtest: eDP-1 [450.061521] Dynamic subtest eDP-1: SKIP (0.000s) [450.065880] Subtest fbc-psr-sprite-blt: SKIP (0.001s) [450.138575] [091/134] (570s left) i915_selftest (mock) [452.088191] Starting subtest: mock [452.090984] Starting dynamic subtest: sanitycheck [452.811355] Dynamic subtest sanitycheck: SUCCESS (0.723s) [452.820481] Starting dynamic subtest: shmem [453.513894] Dynamic subtest shmem: SUCCESS (0.701s) [453.523269] Starting dynamic subtest: fence [461.102064] Dynamic subtest fence: SUCCESS (7.585s) [461.111085] Starting dynamic subtest: scatterlist [462.855082] Dynamic subtest scatterlist: SUCCESS (1.751s) [462.870951] Starting dynamic subtest: syncmap [466.263078] Dynamic subtest syncmap: SUCCESS (3.406s) [466.277129] Starting dynamic subtest: uncore [466.971243] Dynamic subtest uncore: SUCCESS (0.706s) [466.980710] Starting dynamic subtest: ring [467.724176] Dynamic subtest ring: SUCCESS (0.751s) [467.733292] Starting dynamic subtest: engine [468.463112] Dynamic subtest engine: SUCCESS (0.737s) [468.471965] Starting dynamic subtest: timelines [472.288947] Dynamic subtest timelines: SUCCESS (3.823s) [472.297788] Starting dynamic subtest: requests [475.755276] Dynamic subtest requests: SUCCESS (3.464s) [475.762663] Starting dynamic subtest: objects [476.689509] Dynamic subtest objects: SUCCESS (0.932s) [476.697960] Starting dynamic subtest: phys [477.563557] Dynamic subtest phys: SUCCESS (0.872s) [477.572815] Starting dynamic subtest: dmabuf [478.422651] Dynamic subtest dmabuf: SUCCESS (0.857s) [478.431631] Starting dynamic subtest: vma [483.793079] Dynamic subtest vma: SUCCESS (5.346s) [483.800072] Starting dynamic subtest: evict [485.305464] Dynamic subtest evict: SUCCESS (1.532s) [485.318902] Starting dynamic subtest: gtt [489.039555] Dynamic subtest gtt: SUCCESS (3.731s) [489.048766] Starting dynamic subtest: hugepages [489.999642] Dynamic subtest hugepages: SUCCESS (0.958s) [490.008886] Starting dynamic subtest: memory_region [492.580784] Dynamic subtest memory_region: SUCCESS (2.578s) [492.583493] Subtest mock: SUCCESS (40.493s) [492.611890] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [492.612624] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true [492.615954] [092/134] (528s left) api_intel_allocator (alloc-simple) [494.107815] Starting subtest: alloc-simple [494.114621] Subtest alloc-simple: SUCCESS (0.007s) [494.203513] [FACT api_intel_allocator (alloc-simple)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [494.204724] [FACT api_intel_allocator (alloc-simple)] new: kernel.kmod_is_loaded.i915: true [494.208803] [093/134] (526s left) gem_exec_schedule (implicit-read-write) [494.295067] Starting subtest: implicit-read-write [494.296905] Starting dynamic subtest: rcs0 [494.397205] Dynamic subtest rcs0: SUCCESS (0.107s) [494.408809] Starting dynamic subtest: vcs0 [494.473322] Dynamic subtest vcs0: SUCCESS (0.074s) [494.481081] Starting dynamic subtest: vcs1 [494.555455] Dynamic subtest vcs1: SUCCESS (0.081s) [494.564827] Starting dynamic subtest: vecs0 [494.627330] Dynamic subtest vecs0: SUCCESS (0.071s) [494.638056] Starting dynamic subtest: ccs0 [494.703332] Dynamic subtest ccs0: SUCCESS (0.075s) [494.705719] Subtest implicit-read-write: SUCCESS (0.414s) [496.013071] [094/134] (524s left) gem_userptr_blits (stress-mm) [496.091151] Starting subtest: stress-mm [501.459947] Subtest stress-mm: SUCCESS (5.369s) [501.621155] [095/134] (519s left) kms_psr (psr-sprite-plane-onoff) [501.715757] Starting subtest: psr-sprite-plane-onoff [501.717951] Starting dynamic subtest: eDP-1 [503.453819] Dynamic subtest eDP-1: SUCCESS (1.737s) [503.456059] Subtest psr-sprite-plane-onoff: SUCCESS (1.738s) [504.281710] [096/134] (516s left) kms_pm_rpm (universal-planes-dpms) [506.105067] Starting subtest: universal-planes-dpms [506.107728] Starting dynamic subtest: plane-34 [514.386579] Dynamic subtest plane-34: SUCCESS (8.284s) [514.397284] Starting dynamic subtest: plane-64 [523.004945] Dynamic subtest plane-64: SUCCESS (8.615s) [523.015983] Starting dynamic subtest: plane-94 [531.600693] Dynamic subtest plane-94: SUCCESS (8.593s) [531.610730] Starting dynamic subtest: plane-124 [539.911477] Dynamic subtest plane-124: SUCCESS (8.307s) [539.922654] Starting dynamic subtest: plane-134 [548.588731] Dynamic subtest plane-134: SUCCESS (8.674s) [548.599417] Starting dynamic subtest: plane-144 [556.895708] Dynamic subtest plane-144: SUCCESS (8.304s) [556.898168] Subtest universal-planes-dpms: SUCCESS (50.794s) [557.290151] [097/134] (463s left) i915_pm_rpm (gem-idle) [559.119962] Starting subtest: gem-idle [565.317857] Subtest gem-idle: SUCCESS (6.203s) [565.667445] [098/134] (455s left) gem_ctx_persistence (file) [566.845141] Starting subtest: file [567.022837] Subtest file: SUCCESS (0.177s) [567.175936] [099/134] (453s left) gem_exec_fence (parallel) [567.343816] Starting subtest: parallel [567.346327] Starting dynamic subtest: rcs0 [569.500756] Dynamic subtest rcs0: SUCCESS (2.157s) [569.510362] Starting dynamic subtest: bcs0 [571.651079] Dynamic subtest bcs0: SUCCESS (2.149s) [571.660532] Starting dynamic subtest: vcs0 [573.800874] Dynamic subtest vcs0: SUCCESS (2.149s) [573.810486] Starting dynamic subtest: vcs1 [575.951696] Dynamic subtest vcs1: SUCCESS (2.150s) [575.960769] Starting dynamic subtest: vecs0 [578.104898] Dynamic subtest vecs0: SUCCESS (2.152s) [578.116226] Starting dynamic subtest: ccs0 [580.253358] Dynamic subtest ccs0: SUCCESS (2.148s) [580.255320] Subtest parallel: SUCCESS (12.910s) [580.992116] [100/134] (440s left) prime_mmap (test_errors) [581.058769] Starting subtest: test_errors [581.061147] Starting dynamic subtest: test_errors-smem [581.152228] Dynamic subtest test_errors-smem: SUCCESS (0.095s) [581.154876] Subtest test_errors: SUCCESS (0.096s) [581.270985] [101/134] (439s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier) [581.361762] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier [581.389771] Starting dynamic subtest: pipe-A-plane-0 [581.394355] Dynamic subtest pipe-A-plane-0: SKIP (0.000s) [581.404420] Starting dynamic subtest: pipe-A-plane-3 [581.408971] Dynamic subtest pipe-A-plane-3: SKIP (0.000s) [581.417044] Starting dynamic subtest: pipe-A-plane-5 [581.421316] Dynamic subtest pipe-A-plane-5: SKIP (0.000s) [582.445164] Starting dynamic subtest: pipe-B-plane-0 [582.449375] Dynamic subtest pipe-B-plane-0: SKIP (0.000s) [582.457257] Starting dynamic subtest: pipe-B-plane-3 [582.461890] Dynamic subtest pipe-B-plane-3: SKIP (0.000s) [582.470176] Starting dynamic subtest: pipe-B-plane-5 [582.475306] Dynamic subtest pipe-B-plane-5: SKIP (0.000s) [582.753944] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier: SKIP (1.390s) [583.628681] [102/134] (437s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180) [583.750853] Starting subtest: linear-max-hw-stride-32bpp-rotate-180 [584.753413] Subtest linear-max-hw-stride-32bpp-rotate-180: SUCCESS (1.001s) [584.921412] [103/134] (436s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc) [585.022689] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc [585.026118] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [585.140471] [104/134] (436s left) gem_pipe_control_store_loop (reused-buffer) [585.203198] Starting subtest: reused-buffer [587.358053] Subtest reused-buffer: SUCCESS (2.153s) [587.497382] [105/134] (433s left) kms_flip (flip-vs-dpms-on-nop-interruptible) [587.601872] Starting subtest: flip-vs-dpms-on-nop-interruptible [587.606732] Starting dynamic subtest: A-eDP1 [589.433029] Dynamic subtest A-eDP1: SUCCESS (1.829s) [589.443698] Starting dynamic subtest: B-eDP1 [591.274328] Dynamic subtest B-eDP1: SUCCESS (1.840s) [591.286148] Starting dynamic subtest: C-eDP1 [593.087157] Dynamic subtest C-eDP1: SUCCESS (1.812s) [593.095658] Starting dynamic subtest: D-eDP1 [594.906020] Dynamic subtest D-eDP1: SUCCESS (1.818s) [594.911312] Subtest flip-vs-dpms-on-nop-interruptible: SUCCESS (7.306s) [596.109610] [106/134] (425s left) gem_ctx_engines (independent) [596.181570] Starting subtest: independent [596.183911] Starting dynamic subtest: rcs0 [596.325057] Dynamic subtest rcs0: SUCCESS (0.144s) [596.336075] Starting dynamic subtest: bcs0 [596.438123] Dynamic subtest bcs0: SUCCESS (0.113s) [596.447962] Starting dynamic subtest: vcs0 [596.561971] Dynamic subtest vcs0: SUCCESS (0.122s) [596.570670] Starting dynamic subtest: vcs1 [596.664127] Dynamic subtest vcs1: SUCCESS (0.102s) [596.673281] Starting dynamic subtest: vecs0 [596.788822] Dynamic subtest vecs0: SUCCESS (0.123s) [596.797706] Starting dynamic subtest: ccs0 [596.919270] Dynamic subtest ccs0: SUCCESS (0.129s) [596.929549] Starting dynamic subtest: all-engines [597.393645] Dynamic subtest all-engines: SUCCESS (0.473s) [597.396362] Subtest independent: SUCCESS (1.215s) [597.987568] [107/134] (423s left) gem_bad_reloc (negative-reloc) [598.055820] Subtest negative-reloc: SKIP (0.000s) [598.138222] [108/134] (423s left) gem_exec_balancer (bonded-semaphore) [598.200415] Starting subtest: bonded-semaphore [598.205066] Subtest bonded-semaphore: SKIP (0.000s) [598.517802] [109/134] (423s left) kms_psr (psr2-primary-render) [598.617164] Starting subtest: psr2-primary-render [598.619486] Starting dynamic subtest: eDP-1 [600.375601] Dynamic subtest eDP-1: SUCCESS (1.758s) [600.377971] Subtest psr2-primary-render: SUCCESS (1.759s) [601.264143] [110/134] (420s left) gem_spin_batch (legacy) [601.320936] Starting subtest: legacy [601.323342] Starting dynamic subtest: default [604.560752] Dynamic subtest default: SUCCESS (3.233s) [604.570960] Starting dynamic subtest: render [607.800903] Dynamic subtest render: SUCCESS (3.236s) [607.815730] Starting dynamic subtest: bsd [611.037606] Dynamic subtest bsd: SUCCESS (3.233s) [611.048055] Starting dynamic subtest: bsd1 [614.271871] Dynamic subtest bsd1: SUCCESS (3.231s) [614.282671] Starting dynamic subtest: bsd2 [617.508464] Dynamic subtest bsd2: SUCCESS (3.233s) [617.519601] Starting dynamic subtest: blt [620.746175] Dynamic subtest blt: SUCCESS (3.234s) [620.755570] Starting dynamic subtest: vebox [623.986310] Dynamic subtest vebox: SUCCESS (3.237s) [623.988566] Subtest legacy: SUCCESS (22.661s) [625.951137] [111/134] (395s left) gem_madvise (dontneed-before-pwrite) [625.986289] Starting subtest: dontneed-before-pwrite [626.015721] Subtest dontneed-before-pwrite: SKIP (0.027s) [626.082605] [112/134] (395s left) gem_exec_await (wide-all) [626.314036] Starting subtest: wide-all [649.839060] Subtest wide-all: SUCCESS (23.522s) [650.040060] [113/134] (371s left) kms_joiner (basic-max-non-joiner) [650.188261] Starting subtest: basic-max-non-joiner [650.192856] Subtest basic-max-non-joiner: SKIP (0.000s) [650.269471] [114/134] (371s left) gem_render_copy (yf-tiled-to-vebox-y-tiled) [650.325294] Starting subtest: yf-tiled-to-vebox-y-tiled [650.329991] Subtest yf-tiled-to-vebox-y-tiled: SKIP (0.000s) [650.533626] [115/134] (371s left) syncobj_wait (single-wait-for-submit-signaled) [650.603265] Starting subtest: single-wait-for-submit-signaled [650.605702] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s) [650.713235] [116/134] (371s left) gem_mmap_gtt (fault-concurrent-x) [650.778840] Subtest fault-concurrent-X: SKIP (0.000s) [650.844321] [117/134] (371s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt) [650.948821] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt [650.952934] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s) [651.064402] [118/134] (370s left) kms_frontbuffer_tracking (fbcpsr-abgr161616f-draw-mmap-wc) [651.166810] Starting subtest: fbcpsr-abgr161616f-draw-mmap-wc [651.170812] Subtest fbcpsr-abgr161616f-draw-mmap-wc: SKIP (0.000s) [651.272307] [119/134] (370s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs) [651.371873] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs [651.374174] Starting dynamic subtest: pipe-A-eDP-1 [651.539048] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.160s) [651.549998] Starting dynamic subtest: pipe-B-eDP-1 [651.568051] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [651.578051] Starting dynamic subtest: pipe-C-eDP-1 [651.593996] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [651.602284] Starting dynamic subtest: pipe-D-eDP-1 [651.618456] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s) [651.620058] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs: SUCCESS (0.169s) [653.819222] [120/134] (368s left) kms_content_protection (uevent-hdcp14) [653.963647] Starting subtest: uevent-hdcp14 [653.968726] Subtest uevent-hdcp14: SKIP (0.000s) [654.110929] [121/134] (367s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted-signaled) [654.161376] Starting subtest: multi-wait-all-for-submit-available-submitted-signaled [654.163656] Subtest multi-wait-all-for-submit-available-submitted-signaled: SUCCESS (0.000s) [654.285882] [122/134] (367s left) kms_frontbuffer_tracking (psr-abgr161616f-draw-render) [654.388805] Starting subtest: psr-abgr161616f-draw-render [654.392970] Subtest psr-abgr161616f-draw-render: SKIP (0.000s) [654.505732] [123/134] (367s left) kms_psr (pr-primary-mmap-cpu) [654.607288] Starting subtest: pr-primary-mmap-cpu [654.611331] Subtest pr-primary-mmap-cpu: SKIP (0.000s) [654.690458] [124/134] (367s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip) [654.793639] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip [654.797277] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s) [654.909849] [125/134] (367s left) kms_chamelium_color (gamma) [655.009473] Subtest gamma: SKIP (0.000s) [655.065368] [126/134] (367s left) kms_ccs (crc-primary-basic-4-tiled-mtl-mc-ccs) [655.146545] Starting subtest: crc-primary-basic-4-tiled-mtl-mc-ccs [655.148203] Starting dynamic subtest: pipe-A-eDP-1 [657.223989] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.076s) [657.233582] Starting dynamic subtest: pipe-B-eDP-1 [659.364469] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.142s) [659.372515] Starting dynamic subtest: pipe-C-eDP-1 [661.443531] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.077s) [661.454453] Starting dynamic subtest: pipe-D-eDP-1 [663.524986] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.080s) [663.527079] Subtest crc-primary-basic-4-tiled-mtl-mc-ccs: SUCCESS (8.379s) [664.743282] [127/134] (357s left) kms_vrr (seamless-rr-switch-vrr) [664.848099] Starting subtest: seamless-rr-switch-vrr [664.854119] Subtest seamless-rr-switch-vrr: SKIP (0.000s) [664.930345] [128/134] (357s left) kms_flip (2x-flip-vs-blocking-wf-vblank) [665.031194] Starting subtest: 2x-flip-vs-blocking-wf-vblank [665.039658] Subtest 2x-flip-vs-blocking-wf-vblank: SKIP (0.010s) [665.173240] [129/134] (357s left) kms_vblank (query-forked-busy-hang) [665.265535] Starting subtest: query-forked-busy-hang [665.267575] Starting dynamic subtest: pipe-A-eDP-1 [691.680737] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.414s) [691.694232] Starting dynamic subtest: pipe-D-eDP-1 [706.635074] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.952s) [706.637482] Subtest query-forked-busy-hang: SUCCESS (41.371s) [707.516141] [130/134] (314s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt) [707.608539] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt [714.363343] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SUCCESS (6.757s) [714.522711] [131/134] (307s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip) [714.632146] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip [715.411767] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SUCCESS (0.781s) [715.601175] [132/134] (306s left) kms_addfb_basic (bad-pitch-0) [715.660213] Starting subtest: bad-pitch-0 [715.662552] Subtest bad-pitch-0: SUCCESS (0.000s) [715.839243] [133/134] (306s left) kms_color (ctm-red-to-blue) [715.932892] Starting subtest: ctm-red-to-blue [715.934719] Starting dynamic subtest: pipe-A-eDP-1 [716.644649] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.714s) [716.656037] Starting dynamic subtest: pipe-B-eDP-1 [718.051239] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.403s) [718.060317] Starting dynamic subtest: pipe-C-eDP-1 [719.452741] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.401s) [719.462036] Starting dynamic subtest: pipe-D-eDP-1 [720.779297] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.328s) [720.781600] Subtest ctm-red-to-blue: SUCCESS (4.849s) [721.596190] [134/134] (301s left) kms_psr2_sf (fbc-pr-primary-plane-update-sf-dmg-area) [726.670713] Starting subtest: fbc-pr-primary-plane-update-sf-dmg-area [726.675230] Subtest fbc-pr-primary-plane-update-sf-dmg-area: SKIP (0.002s) [727.544691] Closing watchdogs results: parsing output: 0/ for test: kms_plane_alpha_blend results: parsing output: 1/ for test: kms_plane results: parsing output: 2/ for test: gem_mmap_gtt results: parsing output: 3/ for test: kms_flip results: parsing output: 4/ for test: syncobj_wait results: parsing output: 5/ for test: gem_vm_create results: parsing output: 6/ for test: kms_async_flips results: parsing output: 7/ for test: syncobj_timeline results: parsing output: 8/ for test: gem_pxp results: parsing output: 9/ for test: device_reset results: parsing output: 10/ for test: gem_mmap_gtt results: parsing output: 11/ for test: kms_ccs results: parsing output: 12/ for test: kms_cursor_legacy results: parsing output: 13/ for test: kms_frontbuffer_tracking results: parsing output: 14/ for test: kms_atomic results: parsing output: 15/ for test: kms_frontbuffer_tracking results: parsing output: 16/ for test: i915_drm_fdinfo results: parsing output: 17/ for test: gem_exec_params results: parsing output: 18/ for test: kms_frontbuffer_tracking results: parsing output: 19/ for test: syncobj_timeline results: parsing output: 20/ for test: gem_exec_whisper results: parsing output: 21/ for test: vgem_basic results: parsing output: 22/ for test: kms_pm_rpm results: parsing output: 23/ for test: kms_plane_scaling results: parsing output: 24/ for test: kms_frontbuffer_tracking results: parsing output: 25/ for test: kms_frontbuffer_tracking results: parsing output: 26/ for test: sysfs_preempt_timeout results: parsing output: 27/ for test: kms_cursor_crc results: parsing output: 28/ for test: kms_plane results: parsing output: 29/ for test: perf_pmu results: parsing output: 30/ for test: kms_flip results: parsing output: 31/ for test: kms_frontbuffer_tracking results: parsing output: 32/ for test: gem_readwrite results: parsing output: 33/ for test: kms_frontbuffer_tracking results: parsing output: 34/ for test: kms_vblank results: parsing output: 35/ for test: gem_ctx_shared results: parsing output: 36/ for test: gem_exec_whisper results: parsing output: 37/ for test: kms_rmfb results: parsing output: 38/ for test: kms_big_fb results: parsing output: 39/ for test: kms_frontbuffer_tracking results: parsing output: 40/ for test: kms_psr2_sf results: parsing output: 41/ for test: kms_big_fb results: parsing output: 42/ for test: gem_ctx_param results: parsing output: 43/ for test: kms_frontbuffer_tracking results: parsing output: 44/ for test: kms_cursor_legacy results: parsing output: 45/ for test: sw_sync results: parsing output: 46/ for test: kms_frontbuffer_tracking results: parsing output: 47/ for test: gem_partial_pwrite_pread results: parsing output: 48/ for test: gem_exec_schedule results: parsing output: 49/ for test: kms_flip_scaled_crc results: parsing output: 50/ for test: gem_ctx_persistence results: parsing output: 51/ for test: syncobj_timeline results: parsing output: 52/ for test: gem_ctx_bad_destroy results: parsing output: 53/ for test: kms_psr results: parsing output: 54/ for test: gem_exec_params results: parsing output: 55/ for test: kms_cursor_legacy results: parsing output: 56/ for test: kms_frontbuffer_tracking results: parsing output: 57/ for test: gem_fence_thrash results: parsing output: 58/ for test: kms_big_fb results: parsing output: 59/ for test: kms_cursor_edge_walk results: parsing output: 60/ for test: prime_vgem results: parsing output: 61/ for test: kms_flip results: parsing output: 62/ for test: gem_exec_reloc results: parsing output: 63/ for test: kms_chamelium_hpd results: parsing output: 64/ for test: kms_ccs results: parsing output: 65/ for test: kms_frontbuffer_tracking results: parsing output: 66/ for test: syncobj_timeline results: parsing output: 67/ for test: syncobj_wait results: parsing output: 68/ for test: syncobj_wait results: parsing output: 69/ for test: gen9_exec_parse results: parsing output: 70/ for test: perf results: parsing output: 71/ for test: kms_frontbuffer_tracking results: parsing output: 72/ for test: kms_frontbuffer_tracking results: parsing output: 73/ for test: gem_ctx_param results: parsing output: 74/ for test: api_intel_bb results: parsing output: 75/ for test: kms_pipe_crc_basic results: parsing output: 76/ for test: kms_cdclk results: parsing output: 77/ for test: gem_exec_reloc results: parsing output: 78/ for test: kms_psr results: parsing output: 79/ for test: kms_cursor_legacy results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: kms_cursor_crc results: parsing output: 82/ for test: gem_exec_fence results: parsing output: 83/ for test: gem_pxp results: parsing output: 84/ for test: kms_draw_crc results: parsing output: 85/ for test: gem_sync results: parsing output: 86/ for test: gen7_exec_parse results: parsing output: 87/ for test: kms_ccs results: parsing output: 88/ for test: kms_frontbuffer_tracking results: parsing output: 89/ for test: kms_psr results: parsing output: 90/ for test: i915_selftest results: parsing output: 91/ for test: api_intel_allocator results: parsing output: 92/ for test: gem_exec_schedule results: parsing output: 93/ for test: gem_userptr_blits results: parsing output: 94/ for test: kms_psr results: parsing output: 95/ for test: kms_pm_rpm results: parsing output: 96/ for test: i915_pm_rpm results: parsing output: 97/ for test: gem_ctx_persistence results: parsing output: 98/ for test: gem_exec_fence results: parsing output: 99/ for test: prime_mmap results: parsing output: 100/ for test: kms_plane results: parsing output: 101/ for test: kms_big_fb results: parsing output: 102/ for test: kms_frontbuffer_tracking results: parsing output: 103/ for test: gem_pipe_control_store_loop results: parsing output: 104/ for test: kms_flip results: parsing output: 105/ for test: gem_ctx_engines results: parsing output: 106/ for test: gem_bad_reloc results: parsing output: 107/ for test: gem_exec_balancer results: parsing output: 108/ for test: kms_psr results: parsing output: 109/ for test: gem_spin_batch results: parsing output: 110/ for test: gem_madvise results: parsing output: 111/ for test: gem_exec_await results: parsing output: 112/ for test: kms_joiner results: parsing output: 113/ for test: gem_render_copy results: parsing output: 114/ for test: syncobj_wait results: parsing output: 115/ for test: gem_mmap_gtt results: parsing output: 116/ for test: kms_frontbuffer_tracking results: parsing output: 117/ for test: kms_frontbuffer_tracking results: parsing output: 118/ for test: kms_ccs results: parsing output: 119/ for test: kms_content_protection results: parsing output: 120/ for test: syncobj_timeline results: parsing output: 121/ for test: kms_frontbuffer_tracking results: parsing output: 122/ for test: kms_psr results: parsing output: 123/ for test: kms_big_fb results: parsing output: 124/ for test: kms_chamelium_color results: parsing output: 125/ for test: kms_ccs results: parsing output: 126/ for test: kms_vrr results: parsing output: 127/ for test: kms_flip results: parsing output: 128/ for test: kms_vblank results: parsing output: 129/ for test: kms_frontbuffer_tracking results: parsing output: 130/ for test: kms_big_fb results: parsing output: 131/ for test: kms_addfb_basic results: parsing output: 132/ for test: kms_color results: parsing output: 133/ for test: kms_psr2_sf Done.