[57.241260] Initializing watchdogs [57.241308] /dev/watchdog0 [57.256232] [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.260769] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [57.263066] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [57.266206] [001/131] (960s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-async-flip) [57.402549] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-async-flip [57.406758] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.001s) [57.521984] [002/131] (960s left) gem_exec_fence (submit3) [57.711864] Starting subtest: submit3 [57.716667] Subtest submit3: SKIP (0.000s) [60.023837] [FACT gem_exec_fence (submit3)] new: kernel.kmod_is_loaded.vgem: true [60.026733] [003/131] (957s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt) [60.130760] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt [60.135282] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [60.247438] [004/131] (957s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc) [60.341677] Starting subtest: fbc-rgb101010-draw-mmap-wc [65.263462] Subtest fbc-rgb101010-draw-mmap-wc: SUCCESS (4.902s) [66.402061] [005/131] (951s left) gem_exec_balancer (noheartbeat) [66.686780] Starting subtest: noheartbeat [66.691645] Subtest noheartbeat: SKIP (0.000s) [66.856345] [006/131] (951s left) kms_chamelium_color (ctm-blue-to-red) [67.015002] Subtest ctm-blue-to-red: SKIP (0.000s) [67.220632] [007/131] (950s left) gem_workarounds (suspend-resume) [67.343084] Starting subtest: suspend-resume [83.677237] Subtest suspend-resume: SUCCESS (5.698s) [95.861268] [008/131] (934s left) kms_plane_scaling (planes-downscale-factor-0-75-unity-scaling) [96.000578] Starting subtest: planes-downscale-factor-0-75-unity-scaling [96.003097] Starting dynamic subtest: pipe-A [96.067702] Dynamic subtest pipe-A: SUCCESS (0.066s) [96.078338] Starting dynamic subtest: pipe-B [97.223883] Dynamic subtest pipe-B: SUCCESS (1.106s) [97.233274] Starting dynamic subtest: pipe-C [98.382129] Dynamic subtest pipe-C: SUCCESS (1.114s) [98.390778] Starting dynamic subtest: pipe-D [99.538599] Dynamic subtest pipe-D: SUCCESS (1.119s) [99.541120] Subtest planes-downscale-factor-0-75-unity-scaling: SUCCESS (3.410s) [100.749671] [009/131] (929s left) gem_pxp (create-regular-buffer) [100.884544] Starting subtest: create-regular-buffer [100.886570] Subtest create-regular-buffer: SUCCESS (0.000s) [101.014068] [010/131] (929s left) gem_exec_params (rel-constants-invalid-rel-gen5) [101.082781] Starting subtest: rel-constants-invalid-rel-gen5 [101.085241] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s) [101.208948] [011/131] (929s left) gem_exec_nop (basic-series) [101.283108] Starting subtest: basic-series [117.528207] Subtest basic-series: SUCCESS (16.092s) [117.803961] [012/131] (912s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-wc) [117.905426] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-wc [117.909544] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [118.017041] [013/131] (912s left) kms_psr (fbc-psr-primary-page-flip) [118.123195] Starting subtest: fbc-psr-primary-page-flip [118.125512] Starting dynamic subtest: eDP-1 [118.130117] Dynamic subtest eDP-1: SKIP (0.000s) [118.134725] Subtest fbc-psr-primary-page-flip: SKIP (0.001s) [118.222660] [014/131] (912s left) i915_pm_rps (engine-order) [118.300058] Starting subtest: engine-order [124.560432] Subtest engine-order: SUCCESS (6.245s) [124.710189] [015/131] (905s left) gem_softpin (evict-active) [124.783239] Starting subtest: evict-active [124.793378] Subtest evict-active: SUCCESS (0.010s) [124.927620] [016/131] (905s left) syncobj_timeline (wait-delayed-signal) [124.979193] Starting subtest: wait-delayed-signal [125.082759] Subtest wait-delayed-signal: SUCCESS (0.103s) [125.190794] [017/131] (905s left) kms_panel_fitting (atomic-fastset) [125.296606] Starting subtest: atomic-fastset [125.299045] Starting dynamic subtest: pipe-A-eDP-1 [125.437631] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.143s) [125.449042] Starting dynamic subtest: pipe-B-eDP-1 [126.688667] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.243s) [126.700571] Starting dynamic subtest: pipe-C-eDP-1 [127.880237] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.183s) [127.890773] Starting dynamic subtest: pipe-D-eDP-1 [129.016350] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.129s) [129.018757] Subtest atomic-fastset: SUCCESS (3.700s) [130.292685] [018/131] (900s left) kms_big_fb (x-tiled-16bpp-rotate-270) [130.401542] Starting subtest: x-tiled-16bpp-rotate-270 [130.420685] Subtest x-tiled-16bpp-rotate-270: SKIP (0.019s) [130.559413] [019/131] (900s left) api_intel_bb (render-ccs) [130.615096] Starting subtest: render-ccs [130.971587] Subtest render-ccs: SUCCESS (0.354s) [131.120249] [020/131] (899s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc) [131.215787] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc [131.218196] Starting dynamic subtest: pipe-A-eDP-1 [131.240479] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [131.251463] Starting dynamic subtest: pipe-B-eDP-1 [131.271724] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [131.279716] Starting dynamic subtest: pipe-C-eDP-1 [131.301277] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [131.309533] Starting dynamic subtest: pipe-D-eDP-1 [131.330788] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [131.335100] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s) [133.481344] [021/131] (897s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-signaled) [133.538415] Starting subtest: multi-wait-all-for-submit-unsubmitted-signaled [133.641587] Subtest multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.102s) [133.739895] [022/131] (896s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move) [133.850676] Starting subtest: psr-2p-primscrn-cur-indfb-move [133.854698] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s) [134.000567] [023/131] (896s left) gem_lmem_swapping (heavy-multi) [134.045027] Subtest heavy-multi: SKIP (0.000s) [134.082675] [024/131] (896s left) kms_async_flips (test-cursor) [134.188582] Starting subtest: test-cursor [134.192896] Subtest test-cursor: SKIP (0.000s) [135.412276] [025/131] (895s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf) [140.494285] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-sf [140.496697] Starting dynamic subtest: pipe-A-eDP-1 [141.281611] Dynamic subtest pipe-A-eDP-1: SKIP (0.783s) [141.292666] Starting dynamic subtest: pipe-B-eDP-1 [142.414865] Dynamic subtest pipe-B-eDP-1: SKIP (1.130s) [142.419145] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (1.917s) [143.627687] [026/131] (887s left) kms_plane_multiple (2x-tiling-4) [143.731195] Starting subtest: 2x-tiling-4 [143.735499] Subtest 2x-tiling-4: SKIP (0.000s) [143.827622] [027/131] (887s left) gem_ctx_param (invalid-param-set) [143.878335] Starting subtest: invalid-param-set [143.880711] Subtest invalid-param-set: SUCCESS (0.000s) [143.983380] [028/131] (887s left) kms_ccs (bad-pixel-format-y-tiled-ccs) [144.086635] Starting subtest: bad-pixel-format-y-tiled-ccs [144.089024] Starting dynamic subtest: pipe-A-eDP-1 [144.112721] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [144.124293] Starting dynamic subtest: pipe-B-eDP-1 [144.145900] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [144.154225] Starting dynamic subtest: pipe-C-eDP-1 [144.175781] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [144.184127] Starting dynamic subtest: pipe-D-eDP-1 [144.205944] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [144.210301] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.003s) [146.383285] [029/131] (884s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers) [146.486432] Starting subtest: plane-downscale-factor-0-5-with-modifiers [146.488794] Starting dynamic subtest: pipe-A [146.507824] Dynamic subtest pipe-A: SKIP (0.016s) [146.519016] Starting dynamic subtest: pipe-B [146.537283] Dynamic subtest pipe-B: SKIP (0.031s) [146.546988] Starting dynamic subtest: pipe-C [146.568296] Dynamic subtest pipe-C: SKIP (0.031s) [146.577151] Starting dynamic subtest: pipe-D [146.600850] Dynamic subtest pipe-D: SKIP (0.031s) [146.604343] Subtest plane-downscale-factor-0-5-with-modifiers: SKIP (0.111s) [146.741327] [030/131] (884s left) syncobj_timeline (multi-wait-all-available-submitted-signaled) [146.803381] Starting subtest: multi-wait-all-available-submitted-signaled [146.805634] Subtest multi-wait-all-available-submitted-signaled: SUCCESS (0.000s) [146.920102] [031/131] (884s left) perf (missing-sample-flags) [147.061131] Starting subtest: missing-sample-flags [147.063353] Subtest missing-sample-flags: SUCCESS (0.000s) [147.106697] [032/131] (884s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-pwrite) [147.214738] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-pwrite [153.345411] Subtest fbc-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (6.128s) [154.497575] [033/131] (876s left) kms_pm_rpm (system-suspend-idle) [156.658701] Starting subtest: system-suspend-idle [175.918681] Subtest system-suspend-idle: SUCCESS (4.745s) [185.347473] [034/131] (854s left) kms_vblank (wait-forked) [185.458499] Starting subtest: wait-forked [185.460760] Starting dynamic subtest: pipe-A-eDP-1 [187.327303] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.795s) [187.342722] Starting dynamic subtest: pipe-D-eDP-1 [189.861129] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.458s) [189.863075] Subtest wait-forked: SUCCESS (4.256s) [190.771052] [035/131] (849s left) kms_big_fb (y-tiled-32bpp-rotate-0) [190.891806] Starting subtest: y-tiled-32bpp-rotate-0 [190.896474] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s) [191.028289] [036/131] (849s left) kms_pipe_crc_basic (read-crc) [191.128289] Starting subtest: read-crc [191.130224] Starting dynamic subtest: pipe-A-eDP-1 [191.831934] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.687s) [191.842494] Starting dynamic subtest: pipe-B-eDP-1 [193.264570] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.406s) [193.275439] Starting dynamic subtest: pipe-C-eDP-1 [194.585217] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.301s) [194.595383] Starting dynamic subtest: pipe-D-eDP-1 [195.925677] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.321s) [195.928013] Subtest read-crc: SUCCESS (4.721s) [196.784069] [037/131] (843s left) kms_cursor_legacy (single-move) [196.922055] Starting subtest: single-move [196.924213] Starting dynamic subtest: pipe-A [202.343351] Dynamic subtest pipe-A: SUCCESS (5.379s) [202.354478] Starting dynamic subtest: pipe-B [207.745922] Dynamic subtest pipe-B: SUCCESS (5.380s) [207.756658] Starting dynamic subtest: pipe-C [213.138188] Dynamic subtest pipe-C: SUCCESS (5.379s) [213.148619] Starting dynamic subtest: pipe-D [218.525840] Dynamic subtest pipe-D: SUCCESS (5.380s) [218.537081] Starting dynamic subtest: all-pipes [223.924717] Dynamic subtest all-pipes: SUCCESS (5.387s) [223.926897] Subtest single-move: SUCCESS (26.913s) [224.083903] [038/131] (816s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf) [229.135454] Starting subtest: pr-overlay-plane-move-continuous-exceed-sf [229.140093] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.002s) [230.003495] [039/131] (810s left) gem_unref_active_buffers [230.231273] [040/131] (810s left) kms_psr (fbc-psr2-primary-mmap-gtt) [230.323551] Starting subtest: fbc-psr2-primary-mmap-gtt [230.325843] Starting dynamic subtest: eDP-1 [230.329802] Dynamic subtest eDP-1: SKIP (0.000s) [230.333743] Subtest fbc-psr2-primary-mmap-gtt: SKIP (0.001s) [230.423814] [041/131] (810s left) syncobj_wait (invalid-signal-zero-handles) [230.495454] Starting subtest: invalid-signal-zero-handles [230.497784] Subtest invalid-signal-zero-handles: SUCCESS (0.000s) [230.613685] [042/131] (809s left) gen9_exec_parse (bb-oversize) [230.671180] Subtest bb-oversize: SKIP (0.000s) [230.751334] [043/131] (809s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted) [230.812824] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted [230.916020] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.103s) [231.017909] [044/131] (809s left) gem_exec_reloc (basic-write-cpu-noreloc) [231.079873] Subtest basic-write-cpu-noreloc: SKIP (0.000s) [231.155269] [045/131] (809s left) gem_mmap_offset (bad-flags) [231.205653] Starting subtest: bad-flags [231.207557] Subtest bad-flags: SUCCESS (0.000s) [231.340792] [046/131] (809s left) kms_cursor_legacy (cursor-vs-flip-legacy) [231.463908] Starting subtest: cursor-vs-flip-legacy [260.765249] Subtest cursor-vs-flip-legacy: SUCCESS (29.287s) [261.648802] [047/131] (779s left) kms_rotation_crc (sprite-rotation-90-pos-100-0) [261.740634] Starting subtest: sprite-rotation-90-pos-100-0 [261.744936] Subtest sprite-rotation-90-pos-100-0: SKIP (0.001s) [261.839335] [048/131] (778s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip) [261.947066] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip [262.981967] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.034s) [263.133023] [049/131] (777s left) gem_create (busy-create) [263.198217] Starting subtest: busy-create [263.200113] Starting dynamic subtest: smem0 [296.087213] Dynamic subtest smem0: SUCCESS (32.882s) [296.089739] Subtest busy-create: SUCCESS (32.884s) [296.303515] [050/131] (744s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-render) [296.433285] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-render [300.631566] Subtest fbc-1p-offscreen-pri-indfb-draw-render: SUCCESS (4.202s) [301.767663] [051/131] (739s left) perf (invalid-open-flags) [301.880761] Starting subtest: invalid-open-flags [301.883670] Subtest invalid-open-flags: SUCCESS (0.000s) [301.923123] [052/131] (739s left) perf (oa-formats) [302.021253] Starting subtest: oa-formats [302.023178] Starting dynamic subtest: 0-rcs0 [302.035252] Dynamic subtest 0-rcs0: SUCCESS (0.016s) [302.045180] Starting dynamic subtest: 1-vecs0 [302.057545] Dynamic subtest 1-vecs0: SUCCESS (0.022s) [302.059758] Subtest oa-formats: SUCCESS (0.039s) [302.100624] [053/131] (738s left) kms_big_fb (4-tiled-8bpp-rotate-270) [302.214305] Starting subtest: 4-tiled-8bpp-rotate-270 [302.235630] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.021s) [302.373390] [054/131] (738s left) kms_cursor_crc (cursor-onscreen-64x21) [302.555155] Starting subtest: cursor-onscreen-64x21 [302.603138] Subtest cursor-onscreen-64x21: SKIP (0.043s) [302.848551] [055/131] (738s left) kms_rotation_crc (primary-4-tiled-reflect-x-180) [302.955873] Starting subtest: primary-4-tiled-reflect-x-180 [310.015870] Subtest primary-4-tiled-reflect-x-180: SUCCESS (7.062s) [311.239803] [056/131] (729s left) kms_cursor_crc (cursor-onscreen-256x256) [311.479627] Starting subtest: cursor-onscreen-256x256 [311.481938] Starting dynamic subtest: pipe-A-eDP-1 [313.580424] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.099s) [313.611268] Starting dynamic subtest: pipe-D-eDP-1 [316.395609] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.792s) [316.397984] Subtest cursor-onscreen-256x256: SUCCESS (4.917s) [317.216955] [057/131] (723s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt) [317.334267] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt [324.748605] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.415s) [324.946592] [058/131] (716s left) kms_async_flips (async-flip-with-page-flip-events-tiled) [325.059877] Starting subtest: async-flip-with-page-flip-events-tiled [325.433025] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs [328.193210] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.759s) [328.202885] Starting dynamic subtest: pipe-A-eDP-1-4 [330.368974] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.174s) [330.380882] Starting dynamic subtest: pipe-A-eDP-1-4 [332.378886] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.008s) [332.388089] Starting dynamic subtest: pipe-A-eDP-1-x [334.569770] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.189s) [334.937801] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs [337.725182] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.795s) [337.734745] Starting dynamic subtest: pipe-B-eDP-1-4 [339.900871] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.174s) [339.910428] Starting dynamic subtest: pipe-B-eDP-1-4 [341.911931] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.009s) [341.921538] Starting dynamic subtest: pipe-B-eDP-1-x [344.102901] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.190s) [344.467848] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs [347.248605] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.787s) [347.263634] Starting dynamic subtest: pipe-C-eDP-1-4 [349.412875] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.162s) [349.425023] Starting dynamic subtest: pipe-C-eDP-1-4 [351.423415] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.009s) [351.432841] Starting dynamic subtest: pipe-C-eDP-1-x [353.603602] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.178s) [353.964334] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs [356.697028] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.739s) [356.707677] Starting dynamic subtest: pipe-D-eDP-1-4 [358.861455] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.163s) [358.873558] Starting dynamic subtest: pipe-D-eDP-1-4 [360.872796] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.009s) [360.882262] Starting dynamic subtest: pipe-D-eDP-1-x [363.051954] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.178s) [363.054579] Subtest async-flip-with-page-flip-events-tiled: SUCCESS (37.984s) [364.313155] [059/131] (676s left) perf (polling) [364.431676] Starting subtest: polling [364.434053] Starting dynamic subtest: 0-rcs0 [374.461924] Dynamic subtest 0-rcs0: SUCCESS (10.026s) [374.471767] Starting dynamic subtest: 1-vecs0 [384.488672] Dynamic subtest 1-vecs0: SUCCESS (10.022s) [384.491716] Subtest polling: SUCCESS (20.050s) [384.540332] [060/131] (656s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-wc) [384.646515] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-wc [384.650624] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [384.767094] [061/131] (656s left) syncobj_timeline (reset-signaled) [384.835055] Starting subtest: reset-signaled [384.837443] Subtest reset-signaled: SUCCESS (0.001s) [384.954052] [062/131] (656s left) kms_rmfb (rmfb-ioctl) [385.053337] Starting subtest: rmfb-ioctl [385.055582] Starting dynamic subtest: pipe-A-eDP-1 [385.158060] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.106s) [385.170107] Starting dynamic subtest: pipe-B-eDP-1 [386.362370] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.200s) [386.373646] Starting dynamic subtest: pipe-C-eDP-1 [387.490526] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.127s) [387.502785] Starting dynamic subtest: pipe-D-eDP-1 [388.624514] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.130s) [388.626981] Subtest rmfb-ioctl: SUCCESS (3.573s) [389.859492] [063/131] (651s left) gem_userptr_blits (create-destroy-sync) [389.923338] Starting subtest: create-destroy-sync [394.934903] Subtest create-destroy-sync: SUCCESS (5.009s) [395.109505] [064/131] (646s left) gem_exec_reloc (basic-gtt-cpu-active) [395.194691] Subtest basic-gtt-cpu-active: SKIP (0.000s) [395.264898] [065/131] (646s left) api_intel_allocator (execbuf-with-allocator) [395.331140] Starting subtest: execbuf-with-allocator [395.339507] Subtest execbuf-with-allocator: SUCCESS (0.010s) [395.504304] [066/131] (646s left) kms_lease (cursor-implicit-plane) [395.603398] Starting subtest: cursor-implicit-plane [395.605584] Starting dynamic subtest: pipe-A-eDP-1 [396.072781] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.468s) [396.082021] Starting dynamic subtest: pipe-B-eDP-1 [397.154484] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.081s) [397.164641] Starting dynamic subtest: pipe-C-eDP-1 [398.284413] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.129s) [398.293925] Starting dynamic subtest: pipe-D-eDP-1 [399.416983] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.127s) [399.418905] Subtest cursor-implicit-plane: SUCCESS (3.812s) [400.305158] [067/131] (641s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size) [400.437698] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size [400.442220] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s) [400.615789] [068/131] (641s left) syncobj_wait (invalid-signal-illegal-handle) [400.679969] Starting subtest: invalid-signal-illegal-handle [400.682152] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s) [400.802242] [069/131] (640s left) kms_psr (psr-primary-blt) [400.910627] Starting subtest: psr-primary-blt [400.912869] Starting dynamic subtest: eDP-1 [402.670208] Dynamic subtest eDP-1: SUCCESS (1.757s) [402.672099] Subtest psr-primary-blt: SUCCESS (1.759s) [403.562759] [070/131] (638s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs) [403.659546] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs [403.661883] Starting dynamic subtest: pipe-A-eDP-1 [403.719779] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [403.729108] Starting dynamic subtest: pipe-B-eDP-1 [403.786354] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [403.796963] Starting dynamic subtest: pipe-C-eDP-1 [403.852315] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [403.861337] Starting dynamic subtest: pipe-D-eDP-1 [403.917986] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [403.922339] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.009s) [405.928049] [071/131] (635s left) kms_psr (pr-primary-blt) [406.026656] Starting subtest: pr-primary-blt [406.031248] Subtest pr-primary-blt: SKIP (0.000s) [406.127967] [072/131] (635s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move) [406.236800] Starting subtest: psr-2p-primscrn-spr-indfb-move [406.240935] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s) [406.355923] [073/131] (635s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling) [406.452716] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling [406.455028] Starting dynamic subtest: pipe-A-default-mode [407.578582] Dynamic subtest pipe-A-default-mode: SKIP (1.125s) [407.583175] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SKIP (1.127s) [407.776978] [074/131] (634s left) gem_exec_schedule (u-semaphore-noskip) [407.848336] Starting subtest: u-semaphore-noskip [408.239624] Subtest u-semaphore-noskip: SUCCESS (0.399s) [408.649171] [075/131] (633s left) i915_drm_fdinfo (memory-info-idle) [408.701537] Starting subtest: memory-info-idle [408.703850] Starting dynamic subtest: smem0 [408.750303] Dynamic subtest smem0: SUCCESS (0.050s) [408.752727] Subtest memory-info-idle: SUCCESS (0.050s) [408.848840] [076/131] (633s left) i915_selftest (live) [410.769506] Starting subtest: live [410.772234] Starting dynamic subtest: sanitycheck [415.206462] Dynamic subtest sanitycheck: SUCCESS (4.438s) [415.216235] Starting dynamic subtest: uncore [419.588366] Dynamic subtest uncore: SUCCESS (4.382s) [419.604628] Starting dynamic subtest: workarounds [422.925996] Dynamic subtest workarounds: SUCCESS (3.335s) [422.935437] Starting dynamic subtest: gt_engines [426.126063] Dynamic subtest gt_engines: SUCCESS (3.198s) [426.136284] Starting dynamic subtest: gt_timelines [441.853160] Dynamic subtest gt_timelines: SUCCESS (15.728s) [441.863515] Starting dynamic subtest: gt_contexts [444.675725] Dynamic subtest gt_contexts: SUCCESS (2.821s) [444.686377] Starting dynamic subtest: gt_lrc [450.996702] Dynamic subtest gt_lrc: SUCCESS (6.319s) [451.012360] Starting dynamic subtest: gt_mocs [454.083549] Dynamic subtest gt_mocs: SUCCESS (3.085s) [454.093108] Starting dynamic subtest: gt_pm [460.965992] Dynamic subtest gt_pm: SUCCESS (6.880s) [460.975666] Starting dynamic subtest: gt_heartbeat [465.349673] Dynamic subtest gt_heartbeat: SUCCESS (4.381s) [465.359300] Starting dynamic subtest: gt_tlb [474.794647] Dynamic subtest gt_tlb: SUCCESS (9.442s) [474.810431] Starting dynamic subtest: requests [486.541294] Dynamic subtest requests: SUCCESS (11.743s) [486.551207] Starting dynamic subtest: migrate [494.697017] Dynamic subtest migrate: SUCCESS (8.153s) [494.706968] Starting dynamic subtest: active [499.202655] Dynamic subtest active: SUCCESS (4.503s) [499.218141] Starting dynamic subtest: objects [504.001630] Dynamic subtest objects: SUCCESS (4.796s) [504.010473] Starting dynamic subtest: mman [507.452215] Dynamic subtest mman: SUCCESS (3.448s) [507.461840] Starting dynamic subtest: dmabuf [511.930929] Dynamic subtest dmabuf: SUCCESS (4.476s) [511.941255] Starting dynamic subtest: vma [516.374928] Dynamic subtest vma: SUCCESS (4.441s) [516.384535] Starting dynamic subtest: coherency [521.654641] Dynamic subtest coherency: SUCCESS (5.276s) [521.664317] Starting dynamic subtest: gtt [531.695768] Dynamic subtest gtt: SUCCESS (10.038s) [531.703922] Starting dynamic subtest: gem [539.876881] Dynamic subtest gem: SUCCESS (8.172s) [539.886615] Starting dynamic subtest: evict [545.411074] Dynamic subtest evict: SUCCESS (5.535s) [545.421501] Starting dynamic subtest: hugepages [556.561101] Dynamic subtest hugepages: SUCCESS (11.146s) [556.570814] Starting dynamic subtest: gem_contexts [585.255945] Dynamic subtest gem_contexts: SUCCESS (28.686s) [585.266658] Starting dynamic subtest: client [589.659115] Dynamic subtest client: SUCCESS (4.401s) [589.669277] Starting dynamic subtest: gem_migrate [594.122201] Dynamic subtest gem_migrate: SUCCESS (4.460s) [594.132511] Starting dynamic subtest: reset [596.996376] Dynamic subtest reset: SUCCESS (2.871s) [597.006801] Starting dynamic subtest: memory_region [601.386692] Dynamic subtest memory_region: SUCCESS (4.387s) [601.395356] Starting dynamic subtest: hangcheck [614.653881] Dynamic subtest hangcheck: SUCCESS (13.261s) [614.669962] Starting dynamic subtest: execlists [619.137869] Dynamic subtest execlists: SUCCESS (4.481s) [619.148402] Starting dynamic subtest: ring_submission [623.599071] Dynamic subtest ring_submission: SUCCESS (4.458s) [623.609089] Starting dynamic subtest: perf [628.059953] Dynamic subtest perf: SUCCESS (4.458s) [628.069892] Starting dynamic subtest: slpc [642.311663] Dynamic subtest slpc: SUCCESS (14.246s) [642.326985] Starting dynamic subtest: guc [646.379795] Dynamic subtest guc: SUCCESS (4.064s) [646.390192] Starting dynamic subtest: guc_multi_lrc [650.847663] Dynamic subtest guc_multi_lrc: SUCCESS (4.465s) [650.857316] Starting dynamic subtest: guc_hang [655.885867] Dynamic subtest guc_hang: SUCCESS (5.034s) [655.896109] Starting dynamic subtest: late_gt_pm [660.314008] Dynamic subtest late_gt_pm: SUCCESS (4.425s) [660.316711] Subtest live: SUCCESS (249.513s) [660.345757] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [660.346422] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true [660.349628] [077/131] (381s left) gem_userptr_blits (nohangcheck) [661.982405] Starting subtest: nohangcheck [662.262852] Subtest nohangcheck: SUCCESS (0.276s) [662.373341] [FACT gem_userptr_blits (nohangcheck)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [662.374573] [FACT gem_userptr_blits (nohangcheck)] new: kernel.kmod_is_loaded.i915: true [662.379413] [078/131] (379s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs) [662.477368] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs [662.479643] Starting dynamic subtest: pipe-A-eDP-1 [663.345898] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.861s) [663.356280] Starting dynamic subtest: pipe-B-eDP-1 [665.265944] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.915s) [665.276911] Starting dynamic subtest: pipe-C-eDP-1 [666.814503] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.550s) [666.826246] Starting dynamic subtest: pipe-D-eDP-1 [668.329834] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.513s) [668.332023] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs: SUCCESS (5.844s) [669.531556] [079/131] (372s left) gem_softpin (allocator-nopin) [669.605894] Starting subtest: allocator-nopin [669.713964] Subtest allocator-nopin: SUCCESS (0.107s) [669.868783] [080/131] (372s left) kms_draw_crc (draw-method-pwrite) [669.968433] Starting subtest: draw-method-pwrite [669.970673] Starting dynamic subtest: xrgb8888-untiled [670.523710] Dynamic subtest xrgb8888-untiled: SUCCESS (0.556s) [670.532559] Starting dynamic subtest: rgb565-untiled [670.957416] Dynamic subtest rgb565-untiled: SUCCESS (0.433s) [670.969082] Starting dynamic subtest: xrgb2101010-untiled [671.500816] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.544s) [671.510850] Starting dynamic subtest: xbgr16161616f-untiled [672.244738] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.744s) [672.254241] Starting dynamic subtest: xrgb8888-xtiled [674.021313] Dynamic subtest xrgb8888-xtiled: SUCCESS (1.777s) [674.031298] Starting dynamic subtest: rgb565-xtiled [675.077263] Dynamic subtest rgb565-xtiled: SUCCESS (1.056s) [675.087261] Starting dynamic subtest: xrgb2101010-xtiled [676.785998] Dynamic subtest xrgb2101010-xtiled: SUCCESS (1.708s) [676.795458] Starting dynamic subtest: xbgr16161616f-xtiled [679.961545] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (3.175s) [679.971049] Starting dynamic subtest: xrgb8888-4tiled [681.027650] Dynamic subtest xrgb8888-4tiled: SUCCESS (1.066s) [681.036880] Starting dynamic subtest: rgb565-4tiled [681.560931] Dynamic subtest rgb565-4tiled: SUCCESS (0.532s) [681.573407] Starting dynamic subtest: xrgb2101010-4tiled [682.626471] Dynamic subtest xrgb2101010-4tiled: SUCCESS (1.064s) [682.638620] Starting dynamic subtest: xbgr16161616f-4tiled [685.524740] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (2.897s) [685.527101] Subtest draw-method-pwrite: SUCCESS (15.569s) [685.642988] [081/131] (356s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip) [685.747206] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip [685.751712] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s) [685.866087] [082/131] (356s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt) [685.972308] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt [685.976539] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s) [686.101995] [083/131] (356s left) syncobj_timeline (host-signal-points) [686.156919] Starting subtest: host-signal-points [686.159137] Subtest host-signal-points: SUCCESS (0.004s) [686.281335] [084/131] (356s left) gem_mmap_gtt (basic-small-bo) [686.338253] Subtest basic-small-bo: SKIP (0.000s) [686.402503] [085/131] (355s left) perf_pmu (semaphore-wait-idle) [686.438063] Starting subtest: semaphore-wait-idle [686.439934] Starting dynamic subtest: rcs0 [686.952965] Dynamic subtest rcs0: SUCCESS (0.514s) [686.965446] Starting dynamic subtest: bcs0 [687.467329] Dynamic subtest bcs0: SUCCESS (0.512s) [687.479550] Starting dynamic subtest: vcs0 [687.980822] Dynamic subtest vcs0: SUCCESS (0.511s) [687.993656] Starting dynamic subtest: vcs1 [688.491824] Dynamic subtest vcs1: SUCCESS (0.510s) [688.503628] Starting dynamic subtest: vecs0 [689.005096] Dynamic subtest vecs0: SUCCESS (0.510s) [689.017172] Starting dynamic subtest: ccs0 [689.519868] Dynamic subtest ccs0: SUCCESS (0.512s) [689.522573] Subtest semaphore-wait-idle: SUCCESS (3.085s) [691.115620] [086/131] (351s left) kms_addfb_basic (no-handle) [691.174627] Starting subtest: no-handle [691.176846] Subtest no-handle: SUCCESS (0.000s) [691.339832] [087/131] (351s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite) [691.449192] Starting subtest: fbcpsr-rgb101010-draw-pwrite [698.481879] Subtest fbcpsr-rgb101010-draw-pwrite: SUCCESS (7.039s) [698.628467] [088/131] (343s left) gem_render_copy (yf-tiled-ccs-to-linear) [698.688687] Starting subtest: yf-tiled-ccs-to-linear [698.693102] Subtest yf-tiled-ccs-to-linear: SKIP (0.000s) [698.898295] [089/131] (343s left) kms_flip (wf_vblank-ts-check) [698.999684] Starting subtest: wf_vblank-ts-check [699.002047] Starting dynamic subtest: A-eDP1 [707.914161] Dynamic subtest A-eDP1: SUCCESS (8.919s) [707.923825] Starting dynamic subtest: B-eDP1 [716.844116] Dynamic subtest B-eDP1: SUCCESS (8.931s) [716.854797] Starting dynamic subtest: C-eDP1 [725.751738] Dynamic subtest C-eDP1: SUCCESS (8.908s) [725.765147] Starting dynamic subtest: D-eDP1 [734.690809] Dynamic subtest D-eDP1: SUCCESS (8.939s) [734.693122] Subtest wf_vblank-ts-check: SUCCESS (35.706s) [735.946413] [090/131] (306s left) gem_exec_schedule (deep) [736.141809] Starting subtest: deep [736.144271] Starting dynamic subtest: rcs0 [740.962279] Dynamic subtest rcs0: SKIP (4.817s) [740.971836] Starting dynamic subtest: vcs0 [751.012357] Dynamic subtest vcs0: SUCCESS (10.051s) [751.027375] Starting dynamic subtest: vcs1 [762.361893] Dynamic subtest vcs1: SUCCESS (11.351s) [762.373903] Starting dynamic subtest: vecs0 [773.886259] Dynamic subtest vecs0: SUCCESS (11.524s) [773.900233] Starting dynamic subtest: ccs0 [785.668678] Dynamic subtest ccs0: SUCCESS (11.781s) [785.671217] Subtest deep: SUCCESS (49.529s) [786.772924] [091/131] (255s left) kms_sequence (queue-idle) [786.877430] Starting subtest: queue-idle [786.879679] Starting dynamic subtest: pipe-A-eDP-1 [788.702973] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.824s) [788.713348] Starting dynamic subtest: pipe-B-eDP-1 [791.180066] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.477s) [791.190188] Starting dynamic subtest: pipe-C-eDP-1 [793.594392] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.413s) [793.605550] Starting dynamic subtest: pipe-D-eDP-1 [796.029744] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.431s) [796.031976] Subtest queue-idle: SUCCESS (9.152s) [796.861628] [092/131] (245s left) gem_gtt_cpu_tlb [797.000318] [093/131] (245s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc) [797.092507] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc [803.597951] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (6.507s) [803.735893] [094/131] (239s left) gem_eio (create-ext) [803.959621] Starting subtest: create-ext [804.300094] Subtest create-ext: SUCCESS (0.338s) [804.441251] [095/131] (238s left) gem_partial_pwrite_pread (writes-after-reads-uncached) [804.497239] Subtest writes-after-reads-uncached: SKIP (0.000s) [804.584178] [096/131] (238s left) sysfs_preempt_timeout (idempotent) [804.650778] Starting subtest: idempotent [804.652749] Starting dynamic subtest: vecs0 [804.654559] Dynamic subtest vecs0: SUCCESS (0.000s) [804.665544] Starting dynamic subtest: ccs0 [804.667268] Dynamic subtest ccs0: SUCCESS (0.000s) [804.677064] Starting dynamic subtest: vcs0 [804.678758] Dynamic subtest vcs0: SUCCESS (0.000s) [804.687996] Starting dynamic subtest: bcs0 [804.689794] Dynamic subtest bcs0: SUCCESS (0.000s) [804.698660] Starting dynamic subtest: rcs0 [804.700386] Dynamic subtest rcs0: SUCCESS (0.001s) [804.709415] Starting dynamic subtest: vcs1 [804.711006] Dynamic subtest vcs1: SUCCESS (0.000s) [804.712567] Subtest idempotent: SUCCESS (0.008s) [804.790047] [097/131] (238s left) gem_busy (semaphore) [804.982974] Subtest semaphore: SKIP (0.000s) [805.260594] [098/131] (237s left) sriov_basic (enable-vfs-bind-unbind-each) [805.321937] Starting subtest: enable-vfs-bind-unbind-each [805.324394] Starting dynamic subtest: numvfs-1 [805.402421] Dynamic subtest numvfs-1: FAIL (0.028s) [805.415271] Starting dynamic subtest: numvfs-2 [805.484565] Dynamic subtest numvfs-2: FAIL (0.004s) [805.496120] Starting dynamic subtest: numvfs-3 [805.568948] Dynamic subtest numvfs-3: FAIL (0.004s) [805.580329] Starting dynamic subtest: numvfs-4 [805.655081] Dynamic subtest numvfs-4: FAIL (0.004s) [805.666665] Starting dynamic subtest: numvfs-5 [805.738435] Dynamic subtest numvfs-5: FAIL (0.004s) [805.749690] Starting dynamic subtest: numvfs-6 [805.822214] Dynamic subtest numvfs-6: FAIL (0.004s) [805.833084] Starting dynamic subtest: numvfs-7 [805.905403] Dynamic subtest numvfs-7: FAIL (0.004s) [805.916463] Starting dynamic subtest: numvfs-random [805.989259] Dynamic subtest numvfs-random: FAIL (0.004s) [805.991632] Subtest enable-vfs-bind-unbind-each: FAIL (0.060s) [806.031831] [099/131] (236s left) kms_pm_lpsp (screens-disabled) [807.132654] Starting subtest: screens-disabled [807.136851] Subtest screens-disabled: SKIP (0.000s) [807.229077] [100/131] (235s left) gem_exec_capture (capture-invisible) [807.296536] Starting subtest: capture-invisible [807.298884] Starting dynamic subtest: smem0 [807.303004] Dynamic subtest smem0: SKIP (0.000s) [807.307167] Subtest capture-invisible: SKIP (0.001s) [807.458153] [101/131] (235s left) gem_lmem_swapping (verify-ccs) [807.495763] Subtest verify-ccs: SKIP (0.000s) [807.547028] [102/131] (235s left) kms_joiner (basic-force-ultra-joiner) [807.653967] Starting subtest: basic-force-ultra-joiner [807.658308] Subtest basic-force-ultra-joiner: SKIP (0.000s) [807.747107] [103/131] (235s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-wc) [807.854317] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-wc [814.450000] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (6.598s) [814.580195] [104/131] (228s left) kms_color (legacy-gamma) [814.690341] Starting subtest: legacy-gamma [814.692909] Starting dynamic subtest: pipe-A-eDP-1 [815.394830] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.706s) [815.405440] Starting dynamic subtest: pipe-B-eDP-1 [816.821920] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.427s) [816.832875] Starting dynamic subtest: pipe-C-eDP-1 [818.184300] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.360s) [818.194698] Starting dynamic subtest: pipe-D-eDP-1 [819.517533] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.331s) [819.519516] Subtest legacy-gamma: SUCCESS (4.829s) [820.367300] [105/131] (222s left) gem_exec_schedule (wide) [820.557453] Starting subtest: wide [820.559815] Starting dynamic subtest: rcs0 [831.071823] Dynamic subtest rcs0: SUCCESS (10.512s) [831.085252] Starting dynamic subtest: vcs0 [841.056183] Dynamic subtest vcs0: SUCCESS (9.983s) [841.066816] Starting dynamic subtest: vcs1 [852.962622] Dynamic subtest vcs1: SUCCESS (11.904s) [852.975450] Starting dynamic subtest: vecs0 [863.412778] Dynamic subtest vecs0: SUCCESS (10.448s) [863.426531] Starting dynamic subtest: ccs0 [876.426753] Dynamic subtest ccs0: SUCCESS (13.011s) [876.429259] Subtest wide: SUCCESS (55.864s) [878.112603] [106/131] (165s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-upscaling) [878.220323] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-upscaling [878.222409] Starting dynamic subtest: pipe-A-default-mode [878.529756] Dynamic subtest pipe-A-default-mode: SKIP (0.305s) [878.534339] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-upscaling: SKIP (0.307s) [879.394535] [107/131] (163s left) kms_big_fb (linear-64bpp-rotate-180) [879.499612] Starting subtest: linear-64bpp-rotate-180 [881.045030] Subtest linear-64bpp-rotate-180: SUCCESS (1.545s) [881.281432] [108/131] (162s left) gem_ppgtt (blt-vs-render-ctxn) [881.340314] Starting subtest: blt-vs-render-ctxN [914.521650] Subtest blt-vs-render-ctxN: SUCCESS (33.174s) [914.688771] [109/131] (128s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-plflip-blt) [914.845497] Starting subtest: psr-2p-scndscrn-shrfb-plflip-blt [914.849685] Subtest psr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s) [914.994964] [110/131] (128s left) kms_chamelium_frames (dp-frame-dump) [915.388232] Subtest dp-frame-dump: SKIP (0.000s) [916.182245] [111/131] (127s left) kms_psr2_su (page_flip-nv12) [916.241312] Subtest page_flip-NV12: SKIP (0.000s) [916.301399] [112/131] (127s left) gem_tiling_max_stride [916.419347] [113/131] (127s left) perf_pmu (busy-idle) [916.463289] Starting subtest: busy-idle [916.465483] Starting dynamic subtest: rcs0 [917.177656] Dynamic subtest rcs0: SUCCESS (0.716s) [917.191503] Starting dynamic subtest: bcs0 [917.846385] Dynamic subtest bcs0: SUCCESS (0.667s) [917.862388] Starting dynamic subtest: vcs0 [919.047515] Dynamic subtest vcs0: SUCCESS (1.196s) [919.061104] Starting dynamic subtest: vcs1 [921.030999] Dynamic subtest vcs1: SUCCESS (1.981s) [921.045163] Starting dynamic subtest: vecs0 [923.015277] Dynamic subtest vecs0: SUCCESS (1.981s) [923.028809] Starting dynamic subtest: ccs0 [923.692755] Dynamic subtest ccs0: SUCCESS (0.677s) [923.695097] Subtest busy-idle: SUCCESS (7.232s) [923.839369] [114/131] (119s left) dmabuf_sync_file (export-before-signal) [923.888335] Starting subtest: export-before-signal [923.890635] Subtest export-before-signal: SUCCESS (0.001s) [923.967832] [115/131] (119s left) gem_exec_reloc (basic-cpu-read) [924.029955] Subtest basic-cpu-read: SKIP (0.000s) [924.094263] [116/131] (119s left) kms_hdr (bpc-switch) [924.196312] Starting subtest: bpc-switch [925.268557] Starting dynamic subtest: pipe-A-eDP-1 [928.660302] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.394s) [928.662603] Subtest bpc-switch: SUCCESS (4.467s) [928.799679] [117/131] (115s left) perf (i915-ref-count) [928.918855] Starting subtest: i915-ref-count [928.989470] Subtest i915-ref-count: SUCCESS (0.068s) [929.049990] [118/131] (114s left) gem_ctx_isolation (nonpriv) [929.122277] Starting subtest: nonpriv [929.124351] Starting dynamic subtest: rcs0 [929.361279] Dynamic subtest rcs0: SUCCESS (0.241s) [929.374799] Starting dynamic subtest: bcs0 [929.592851] Dynamic subtest bcs0: SUCCESS (0.231s) [929.606415] Starting dynamic subtest: vcs0 [929.855151] Dynamic subtest vcs0: SUCCESS (0.262s) [929.868046] Starting dynamic subtest: vcs1 [931.259946] Dynamic subtest vcs1: SUCCESS (1.404s) [931.272936] Starting dynamic subtest: vecs0 [933.335075] Dynamic subtest vecs0: SUCCESS (2.075s) [933.347189] Starting dynamic subtest: ccs0 [935.339434] Dynamic subtest ccs0: SUCCESS (2.004s) [935.342166] Subtest nonpriv: SUCCESS (6.221s) [935.635813] [119/131] (108s left) gem_render_copy (y-tiled-to-vebox-x-tiled) [935.707361] Starting subtest: y-tiled-to-vebox-x-tiled [935.711933] Subtest y-tiled-to-vebox-x-tiled: SKIP (0.000s) [935.931003] [120/131] (108s left) kms_atomic_transition (plane-use-after-nonblocking-unbind) [936.035843] Starting subtest: plane-use-after-nonblocking-unbind [936.038252] Starting dynamic subtest: pipe-A-eDP-1 [936.096009] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.062s) [936.405618] Starting dynamic subtest: pipe-B-eDP-1 [937.210353] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.815s) [937.508674] Subtest plane-use-after-nonblocking-unbind: SUCCESS (1.474s) [938.384340] [121/131] (105s left) i915_hangman (engine-error-state-capture) [938.465154] Starting subtest: engine-error-state-capture [938.467380] Starting dynamic subtest: rcs0 [941.989655] Dynamic subtest rcs0: SUCCESS (3.523s) [942.003521] Starting dynamic subtest: bcs0 [948.006116] Dynamic subtest bcs0: SUCCESS (6.014s) [948.021429] Starting dynamic subtest: vcs0 [954.022563] Dynamic subtest vcs0: SUCCESS (6.014s) [954.037295] Starting dynamic subtest: vcs1 [959.973612] Dynamic subtest vcs1: SUCCESS (5.948s) [959.988079] Starting dynamic subtest: vecs0 [965.989691] Dynamic subtest vecs0: SUCCESS (6.014s) [966.003942] Starting dynamic subtest: ccs0 [972.005012] Dynamic subtest ccs0: SUCCESS (6.013s) [972.007863] Subtest engine-error-state-capture: SUCCESS (33.541s) [972.114707] [122/131] ( 71s left) gem_exec_schedule (pi-shared-iova) [972.302665] Starting subtest: pi-shared-iova [972.306364] Starting dynamic subtest: rcs0 [972.425030] Dynamic subtest rcs0: SUCCESS (0.126s) [972.439603] Starting dynamic subtest: vcs0 [972.511895] Dynamic subtest vcs0: SUCCESS (0.086s) [972.525654] Starting dynamic subtest: vcs1 [972.596321] Dynamic subtest vcs1: SUCCESS (0.085s) [972.610382] Starting dynamic subtest: vecs0 [972.680076] Dynamic subtest vecs0: SUCCESS (0.083s) [972.694052] Starting dynamic subtest: ccs0 [972.805661] Dynamic subtest ccs0: SUCCESS (0.122s) [972.807733] Subtest pi-shared-iova: SUCCESS (0.508s) [974.165030] [123/131] ( 69s left) syncobj_wait (invalid-reset-illegal-handle) [974.229092] Starting subtest: invalid-reset-illegal-handle [974.231395] Subtest invalid-reset-illegal-handle: SUCCESS (0.000s) [974.350436] [124/131] ( 69s left) syncobj_wait (single-wait-all-for-submit-signaled) [974.412192] Starting subtest: single-wait-all-for-submit-signaled [974.414632] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s) [974.561741] [125/131] ( 69s left) kms_cursor_crc (cursor-sliding-512x170) [974.859431] Starting subtest: cursor-sliding-512x170 [974.863618] Subtest cursor-sliding-512x170: SKIP (0.001s) [975.038035] [126/131] ( 69s left) kms_chamelium_hpd (hdmi-hpd-fast) [975.421445] Subtest hdmi-hpd-fast: SKIP (0.000s) [976.270728] [127/131] ( 67s left) gem_ctx_persistence (hostile) [976.344621] Starting subtest: hostile [986.496264] Subtest hostile: SUCCESS (10.147s) [986.653973] [128/131] ( 57s left) kms_frontbuffer_tracking (fbc-rgb565-draw-blt) [986.762640] Starting subtest: fbc-rgb565-draw-blt [990.996889] Subtest fbc-rgb565-draw-blt: SUCCESS (4.237s) [992.216579] [129/131] ( 52s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite) [992.331901] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite [1001.783431] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (9.452s) [1001.937110] [130/131] ( 42s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt) [1002.040196] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt [1002.044538] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [1002.158008] [131/131] ( 42s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move) [1002.256022] Starting subtest: fbc-2p-scndscrn-spr-indfb-move [1002.260295] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s) [1002.369954] Closing watchdogs results: parsing output: 0/ for test: kms_big_fb results: parsing output: 1/ for test: gem_exec_fence results: parsing output: 2/ for test: kms_frontbuffer_tracking results: parsing output: 3/ for test: kms_frontbuffer_tracking results: parsing output: 4/ for test: gem_exec_balancer results: parsing output: 5/ for test: kms_chamelium_color results: parsing output: 6/ for test: gem_workarounds results: parsing output: 7/ for test: kms_plane_scaling results: parsing output: 8/ for test: gem_pxp results: parsing output: 9/ for test: gem_exec_params results: parsing output: 10/ for test: gem_exec_nop results: parsing output: 11/ for test: kms_frontbuffer_tracking results: parsing output: 12/ for test: kms_psr results: parsing output: 13/ for test: i915_pm_rps results: parsing output: 14/ for test: gem_softpin results: parsing output: 15/ for test: syncobj_timeline results: parsing output: 16/ for test: kms_panel_fitting results: parsing output: 17/ for test: kms_big_fb results: parsing output: 18/ for test: api_intel_bb results: parsing output: 19/ for test: kms_ccs results: parsing output: 20/ for test: syncobj_wait results: parsing output: 21/ for test: kms_frontbuffer_tracking results: parsing output: 22/ for test: gem_lmem_swapping results: parsing output: 23/ for test: kms_async_flips results: parsing output: 24/ for test: kms_psr2_sf results: parsing output: 25/ for test: kms_plane_multiple results: parsing output: 26/ for test: gem_ctx_param results: parsing output: 27/ for test: kms_ccs results: parsing output: 28/ for test: kms_plane_scaling results: parsing output: 29/ for test: syncobj_timeline results: parsing output: 30/ for test: perf results: parsing output: 31/ for test: kms_frontbuffer_tracking results: parsing output: 32/ for test: kms_pm_rpm results: parsing output: 33/ for test: kms_vblank results: parsing output: 34/ for test: kms_big_fb results: parsing output: 35/ for test: kms_pipe_crc_basic results: parsing output: 36/ for test: kms_cursor_legacy results: parsing output: 37/ for test: kms_psr2_sf results: parsing output: 38/ for test: gem_unref_active_buffers results: parsing output: 39/ for test: kms_psr results: parsing output: 40/ for test: syncobj_wait results: parsing output: 41/ for test: gen9_exec_parse results: parsing output: 42/ for test: syncobj_timeline results: parsing output: 43/ for test: gem_exec_reloc results: parsing output: 44/ for test: gem_mmap_offset results: parsing output: 45/ for test: kms_cursor_legacy results: parsing output: 46/ for test: kms_rotation_crc results: parsing output: 47/ for test: kms_big_fb results: parsing output: 48/ for test: gem_create results: parsing output: 49/ for test: kms_frontbuffer_tracking results: parsing output: 50/ for test: perf results: parsing output: 51/ for test: perf results: parsing output: 52/ for test: kms_big_fb results: parsing output: 53/ for test: kms_cursor_crc results: parsing output: 54/ for test: kms_rotation_crc results: parsing output: 55/ for test: kms_cursor_crc results: parsing output: 56/ for test: kms_frontbuffer_tracking results: parsing output: 57/ for test: kms_async_flips results: parsing output: 58/ for test: perf results: parsing output: 59/ for test: kms_frontbuffer_tracking results: parsing output: 60/ for test: syncobj_timeline results: parsing output: 61/ for test: kms_rmfb results: parsing output: 62/ for test: gem_userptr_blits results: parsing output: 63/ for test: gem_exec_reloc results: parsing output: 64/ for test: api_intel_allocator results: parsing output: 65/ for test: kms_lease results: parsing output: 66/ for test: kms_cursor_legacy results: parsing output: 67/ for test: syncobj_wait results: parsing output: 68/ for test: kms_psr results: parsing output: 69/ for test: kms_ccs results: parsing output: 70/ for test: kms_psr results: parsing output: 71/ for test: kms_frontbuffer_tracking results: parsing output: 72/ for test: kms_flip_scaled_crc results: parsing output: 73/ for test: gem_exec_schedule results: parsing output: 74/ for test: i915_drm_fdinfo results: parsing output: 75/ for test: i915_selftest results: parsing output: 76/ for test: gem_userptr_blits results: parsing output: 77/ for test: kms_ccs results: parsing output: 78/ for test: gem_softpin results: parsing output: 79/ for test: kms_draw_crc results: parsing output: 80/ for test: kms_big_fb results: parsing output: 81/ for test: kms_frontbuffer_tracking results: parsing output: 82/ for test: syncobj_timeline results: parsing output: 83/ for test: gem_mmap_gtt results: parsing output: 84/ for test: perf_pmu results: parsing output: 85/ for test: kms_addfb_basic results: parsing output: 86/ for test: kms_frontbuffer_tracking results: parsing output: 87/ for test: gem_render_copy results: parsing output: 88/ for test: kms_flip results: parsing output: 89/ for test: gem_exec_schedule results: parsing output: 90/ for test: kms_sequence results: parsing output: 91/ for test: gem_gtt_cpu_tlb results: parsing output: 92/ for test: kms_frontbuffer_tracking results: parsing output: 93/ for test: gem_eio results: parsing output: 94/ for test: gem_partial_pwrite_pread results: parsing output: 95/ for test: sysfs_preempt_timeout results: parsing output: 96/ for test: gem_busy results: parsing output: 97/ for test: sriov_basic results: parsing output: 98/ for test: kms_pm_lpsp results: parsing output: 99/ for test: gem_exec_capture results: parsing output: 100/ for test: gem_lmem_swapping results: parsing output: 101/ for test: kms_joiner results: parsing output: 102/ for test: kms_frontbuffer_tracking results: parsing output: 103/ for test: kms_color results: parsing output: 104/ for test: gem_exec_schedule results: parsing output: 105/ for test: kms_flip_scaled_crc results: parsing output: 106/ for test: kms_big_fb results: parsing output: 107/ for test: gem_ppgtt results: parsing output: 108/ for test: kms_frontbuffer_tracking results: parsing output: 109/ for test: kms_chamelium_frames results: parsing output: 110/ for test: kms_psr2_su results: parsing output: 111/ for test: gem_tiling_max_stride results: parsing output: 112/ for test: perf_pmu results: parsing output: 113/ for test: dmabuf_sync_file results: parsing output: 114/ for test: gem_exec_reloc results: parsing output: 115/ for test: kms_hdr results: parsing output: 116/ for test: perf results: parsing output: 117/ for test: gem_ctx_isolation results: parsing output: 118/ for test: gem_render_copy results: parsing output: 119/ for test: kms_atomic_transition results: parsing output: 120/ for test: i915_hangman results: parsing output: 121/ for test: gem_exec_schedule results: parsing output: 122/ for test: syncobj_wait results: parsing output: 123/ for test: syncobj_wait results: parsing output: 124/ for test: kms_cursor_crc results: parsing output: 125/ for test: kms_chamelium_hpd results: parsing output: 126/ for test: gem_ctx_persistence results: parsing output: 127/ for test: kms_frontbuffer_tracking results: parsing output: 128/ for test: kms_frontbuffer_tracking results: parsing output: 129/ for test: kms_frontbuffer_tracking results: parsing output: 130/ for test: kms_frontbuffer_tracking Done.