[60.234561] Initializing watchdogs [60.234640] /dev/watchdog0 [60.252840] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770] [60.262572] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0 [60.266295] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [60.268801] [001/130] (960s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-sf) [60.554736] Subtest pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s) [60.605601] [002/130] (960s left) gen9_exec_parse (bb-start-param) [60.685007] Subtest bb-start-param: SKIP (0.000s) [60.736810] [003/130] (960s left) kms_cursor_crc (cursor-onscreen-256x256) [61.105447] Starting subtest: cursor-onscreen-256x256 [61.120006] Starting dynamic subtest: pipe-A-DP-3 [63.791753] Dynamic subtest pipe-A-DP-3: SUCCESS (2.682s) [63.834346] Starting dynamic subtest: pipe-D-DP-3 [66.579049] Dynamic subtest pipe-D-DP-3: SUCCESS (2.759s) [66.579961] Subtest cursor-onscreen-256x256: SUCCESS (5.493s) [67.069634] [004/130] (953s left) kms_getfb (getfb-handle-zero) [67.228115] Starting subtest: getfb-handle-zero [67.229235] Subtest getfb-handle-zero: SUCCESS (0.000s) [67.556480] [005/130] (953s left) syncobj_wait (wait-all-for-submit-complex) [67.645444] Starting subtest: wait-all-for-submit-complex [67.859359] Subtest wait-all-for-submit-complex: SUCCESS (0.214s) [67.949586] [006/130] (953s left) syncobj_timeline (etime-multi-wait-submitted) [68.022546] Starting subtest: etime-multi-wait-submitted [68.127602] Subtest etime-multi-wait-submitted: SUCCESS (0.104s) [68.262874] [007/130] (952s left) kms_flip (2x-modeset-vs-vblank-race) [68.464937] Starting subtest: 2x-modeset-vs-vblank-race [68.479269] Subtest 2x-modeset-vs-vblank-race: SKIP (0.014s) [68.594216] [008/130] (952s left) kms_setmode (invalid-clone-single-crtc-stealing) [68.666991] Starting subtest: invalid-clone-single-crtc-stealing [68.669844] Subtest invalid-clone-single-crtc-stealing: SKIP (0.000s) [68.797459] [009/130] (952s left) kms_psr (psr2-dpms) [69.000480] Subtest psr2-dpms: SKIP (0.000s) [69.054724] [010/130] (952s left) kms_chamelium_hpd (hdmi-hpd-enable-disable-mode) [69.355167] Subtest hdmi-hpd-enable-disable-mode: SKIP (0.000s) [69.510027] [011/130] (951s left) kms_lease (cursor-implicit-plane) [69.711152] Starting subtest: cursor-implicit-plane [69.712054] Starting dynamic subtest: pipe-A-DP-3 [70.085602] Dynamic subtest pipe-A-DP-3: SUCCESS (0.374s) [70.095080] Starting dynamic subtest: pipe-B-DP-3 [70.378490] Dynamic subtest pipe-B-DP-3: SUCCESS (0.293s) [70.388675] Starting dynamic subtest: pipe-C-DP-3 [70.662344] Dynamic subtest pipe-C-DP-3: SUCCESS (0.283s) [70.670901] Starting dynamic subtest: pipe-D-DP-3 [70.942367] Dynamic subtest pipe-D-DP-3: SUCCESS (0.279s) [70.943239] Subtest cursor-implicit-plane: SUCCESS (1.233s) [71.200786] [012/130] (950s left) kms_writeback (writeback-fb-id-xrgb2101010) [71.413334] Subtest writeback-fb-id-XRGB2101010: SKIP (0.000s) [71.459224] [013/130] (949s left) kms_psr (psr-sprite-plane-onoff) [71.666384] Subtest psr-sprite-plane-onoff: SKIP (0.000s) [71.724453] [014/130] (949s left) gem_spin_batch (resubmit-new) [71.806140] Starting subtest: resubmit-new [71.807072] Starting dynamic subtest: rcs0 [71.834984] Dynamic subtest rcs0: SUCCESS (0.030s) [71.842712] Starting dynamic subtest: bcs0 [71.843878] Dynamic subtest bcs0: SUCCESS (0.004s) [71.852112] Starting dynamic subtest: vcs0 [71.852994] Dynamic subtest vcs0: SUCCESS (0.004s) [71.860524] Starting dynamic subtest: vcs1 [71.861414] Dynamic subtest vcs1: SUCCESS (0.005s) [71.869566] Starting dynamic subtest: vecs0 [71.870640] Dynamic subtest vecs0: SUCCESS (0.006s) [71.878069] Starting dynamic subtest: vecs1 [71.879221] Dynamic subtest vecs1: SUCCESS (0.004s) [71.886540] Starting dynamic subtest: ccs0 [71.887602] Dynamic subtest ccs0: SUCCESS (0.004s) [71.888651] Subtest resubmit-new: SUCCESS (0.057s) [72.191169] [015/130] (949s left) gem_ctx_param (vm) [72.261364] Starting subtest: vm [72.330405] Subtest vm: SUCCESS (0.069s) [72.477669] [016/130] (949s left) kms_psr (fbc-pr-suspend) [72.675503] Subtest fbc-pr-suspend: SKIP (0.000s) [72.723228] [017/130] (948s left) kms_plane_scaling (plane-upscale-20x20-with-pixel-format) [72.922164] Starting subtest: plane-upscale-20x20-with-pixel-format [72.923015] Starting dynamic subtest: pipe-A [74.572235] Dynamic subtest pipe-A: SUCCESS (1.650s) [74.587392] Starting dynamic subtest: pipe-B [76.289835] Dynamic subtest pipe-B: SUCCESS (1.719s) [76.311447] Starting dynamic subtest: pipe-C [76.607728] Dynamic subtest pipe-C: SUCCESS (0.318s) [76.626666] Starting dynamic subtest: pipe-D [76.926526] Dynamic subtest pipe-D: SUCCESS (0.319s) [76.927624] Subtest plane-upscale-20x20-with-pixel-format: SUCCESS (4.008s) [77.247165] [018/130] (944s left) gem_mmap_gtt (basic-small-copy-xy) [77.320458] Subtest basic-small-copy-XY: SKIP (0.000s) [77.387317] [019/130] (944s left) gem_exec_schedule (u-lateslice) [77.471449] Starting subtest: u-lateslice [77.472367] Starting dynamic subtest: rcs0 [77.513532] Dynamic subtest rcs0: SUCCESS (0.042s) [77.521871] Starting dynamic subtest: bcs0 [77.530492] Dynamic subtest bcs0: SUCCESS (0.017s) [77.538212] Starting dynamic subtest: vcs0 [77.552228] Dynamic subtest vcs0: SUCCESS (0.021s) [77.559944] Starting dynamic subtest: vcs1 [77.570495] Dynamic subtest vcs1: SUCCESS (0.018s) [77.578192] Starting dynamic subtest: vecs0 [77.589361] Dynamic subtest vecs0: SUCCESS (0.019s) [77.597175] Starting dynamic subtest: vecs1 [77.610800] Dynamic subtest vecs1: SUCCESS (0.021s) [77.618519] Starting dynamic subtest: ccs0 [77.628365] Dynamic subtest ccs0: SUCCESS (0.017s) [77.629261] Subtest u-lateslice: SUCCESS (0.157s) [78.012846] [020/130] (943s left) kms_cursor_crc (cursor-sliding-64x21) [78.322613] Starting subtest: cursor-sliding-64x21 [78.327186] Starting dynamic subtest: pipe-A-DP-3 [82.550780] Dynamic subtest pipe-A-DP-3: SUCCESS (4.222s) [82.599812] Starting dynamic subtest: pipe-D-DP-3 [86.819586] Dynamic subtest pipe-D-DP-3: SUCCESS (4.226s) [86.820526] Subtest cursor-sliding-64x21: SUCCESS (8.496s) [87.232994] [021/130] (934s left) kms_color (invalid-gamma-lut-sizes) [87.433185] Starting subtest: invalid-gamma-lut-sizes [87.434103] Starting dynamic subtest: pipe-A [87.505342] Dynamic subtest pipe-A: SUCCESS (0.071s) [87.513285] Starting dynamic subtest: pipe-B [87.514158] Dynamic subtest pipe-B: SUCCESS (0.001s) [87.521910] Starting dynamic subtest: pipe-C [87.522900] Dynamic subtest pipe-C: SUCCESS (0.001s) [87.530138] Starting dynamic subtest: pipe-D [87.530991] Dynamic subtest pipe-D: SUCCESS (0.001s) [87.531940] Subtest invalid-gamma-lut-sizes: SUCCESS (0.075s) [87.716856] [022/130] (934s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc) [87.912245] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc [87.913184] Starting dynamic subtest: pipe-A-DP-3 [87.921887] Dynamic subtest pipe-A-DP-3: SKIP (0.001s) [87.929468] Starting dynamic subtest: pipe-B-DP-3 [87.938040] Dynamic subtest pipe-B-DP-3: SKIP (0.001s) [87.945372] Starting dynamic subtest: pipe-C-DP-3 [87.953833] Dynamic subtest pipe-C-DP-3: SKIP (0.001s) [87.961122] Starting dynamic subtest: pipe-D-DP-3 [87.972071] Dynamic subtest pipe-D-DP-3: SKIP (0.001s) [87.974376] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.006s) [88.370348] [023/130] (933s left) drm_fdinfo (memory-info-idle) [88.436478] Starting subtest: memory-info-idle [88.437408] Starting dynamic subtest: lmem0 [88.518169] Dynamic subtest lmem0: SUCCESS (0.081s) [88.528113] Starting dynamic subtest: smem0 [88.565233] Dynamic subtest smem0: SUCCESS (0.047s) [88.566408] Subtest memory-info-idle: SUCCESS (0.129s) [88.674445] [024/130] (933s left) kms_flip_event_leak (basic) [88.872249] Starting subtest: basic [88.873070] Starting dynamic subtest: pipe-A-DP-3 [89.215058] Dynamic subtest pipe-A-DP-3: SUCCESS (0.342s) [89.227470] Starting dynamic subtest: pipe-B-DP-3 [89.500024] Dynamic subtest pipe-B-DP-3: SUCCESS (0.282s) [89.519680] Starting dynamic subtest: pipe-C-DP-3 [89.797159] Dynamic subtest pipe-C-DP-3: SUCCESS (0.295s) [89.811927] Starting dynamic subtest: pipe-D-DP-3 [90.090964] Dynamic subtest pipe-D-DP-3: SUCCESS (0.291s) [90.092121] Subtest basic: SUCCESS (1.218s) [90.329414] [025/130] (931s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size) [90.525611] Starting subtest: basic-flip-before-cursor-varying-size [91.524271] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.997s) [91.786382] [026/130] (930s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-indfb-draw-mmap-wc) [91.992747] Starting subtest: fbc-1p-offscren-pri-indfb-draw-mmap-wc [91.994431] Subtest fbc-1p-offscren-pri-indfb-draw-mmap-wc: SKIP (0.000s) [92.125820] [027/130] (930s left) gem_exec_balancer (persistence) [92.454243] Starting subtest: persistence [93.752537] Subtest persistence: SUCCESS (1.298s) [93.901723] [028/130] (928s left) kms_lease (empty-lease) [94.102224] Starting subtest: empty-lease [94.103164] Starting dynamic subtest: pipe-A-DP-3 [94.105177] Dynamic subtest pipe-A-DP-3: SUCCESS (0.001s) [94.113221] Starting dynamic subtest: pipe-B-DP-3 [94.114160] Dynamic subtest pipe-B-DP-3: SUCCESS (0.001s) [94.121791] Starting dynamic subtest: pipe-C-DP-3 [94.122641] Dynamic subtest pipe-C-DP-3: SUCCESS (0.001s) [94.130577] Starting dynamic subtest: pipe-D-DP-3 [94.131640] Dynamic subtest pipe-D-DP-3: SUCCESS (0.001s) [94.132536] Subtest empty-lease: SUCCESS (0.010s) [94.239492] [029/130] (928s left) syncobj_timeline (multi-wait-all-signaled) [94.309556] Starting subtest: multi-wait-all-signaled [94.310441] Subtest multi-wait-all-signaled: SUCCESS (0.001s) [94.439265] [030/130] (927s left) gem_fence_thrash (bo-copy) [94.490211] Starting subtest: bo-copy [94.514165] Subtest bo-copy: SKIP (0.024s) [94.587449] [031/130] (927s left) kms_plane_scaling (planes-downscale-factor-0-75) [94.787234] Starting subtest: planes-downscale-factor-0-75 [94.788063] Starting dynamic subtest: pipe-A [94.894066] Dynamic subtest pipe-A: SUCCESS (0.107s) [94.906399] Starting dynamic subtest: pipe-B [95.115454] Dynamic subtest pipe-B: SUCCESS (0.221s) [95.126902] Starting dynamic subtest: pipe-C [95.354120] Dynamic subtest pipe-C: SUCCESS (0.238s) [95.363595] Starting dynamic subtest: pipe-D [95.573571] Dynamic subtest pipe-D: SUCCESS (0.219s) [95.574472] Subtest planes-downscale-factor-0-75: SUCCESS (0.786s) [95.869434] [032/130] (926s left) kms_pipe_crc_basic (disable-crc-after-crtc) [96.067400] Starting subtest: disable-crc-after-crtc [96.069401] Starting dynamic subtest: pipe-A-DP-3 [96.778969] Dynamic subtest pipe-A-DP-3: SUCCESS (0.710s) [96.793127] Starting dynamic subtest: pipe-B-DP-3 [97.353735] Dynamic subtest pipe-B-DP-3: SUCCESS (0.572s) [97.363582] Starting dynamic subtest: pipe-C-DP-3 [98.008911] Dynamic subtest pipe-C-DP-3: SUCCESS (0.653s) [98.017159] Starting dynamic subtest: pipe-D-DP-3 [98.631257] Dynamic subtest pipe-D-DP-3: SUCCESS (0.622s) [98.632211] Subtest disable-crc-after-crtc: SUCCESS (2.564s) [98.890749] [033/130] (923s left) core_setmaster (master-drop-set-user) [101.672911] Starting subtest: master-drop-set-user [101.710909] Subtest master-drop-set-user: SUCCESS (0.038s) [101.748083] [FACT core_setmaster (master-drop-set-user)] new: kernel.kmod_is_loaded.amdgpu: true [101.749071] [FACT core_setmaster (master-drop-set-user)] new: kernel.kmod_is_loaded.xe: true [101.750959] [034/130] (920s left) kms_pm_rpm (pm-tiling) [104.076052] Starting subtest: pm-tiling [104.079105] Subtest pm-tiling: SKIP (0.000s) [104.450857] [035/130] (918s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-plflip-blt) [104.656855] Starting subtest: psr-1p-primscrn-shrfb-plflip-blt [104.658482] Subtest psr-1p-primscrn-shrfb-plflip-blt: SKIP (0.000s) [104.765734] [036/130] (917s left) syncobj_timeline (reset-multiple-signaled) [104.838720] Starting subtest: reset-multiple-signaled [104.839628] Subtest reset-multiple-signaled: SUCCESS (0.000s) [105.007638] [037/130] (917s left) drm_fdinfo (memory-info-shared) [105.070773] Starting subtest: memory-info-shared [105.071668] Starting dynamic subtest: lmem0 [105.159985] Dynamic subtest lmem0: SUCCESS (0.088s) [105.170011] Starting dynamic subtest: smem0 [105.220120] Dynamic subtest smem0: SUCCESS (0.059s) [105.221244] Subtest memory-info-shared: SUCCESS (0.150s) [105.308270] [038/130] (917s left) kms_flip (nonexisting-fb-interruptible) [105.513215] Starting subtest: nonexisting-fb-interruptible [105.518851] Starting dynamic subtest: A-DP3 [105.838998] Dynamic subtest A-DP3: SUCCESS (0.320s) [105.872819] Starting dynamic subtest: B-DP3 [106.114593] Dynamic subtest B-DP3: SUCCESS (0.273s) [106.146553] Starting dynamic subtest: C-DP3 [106.378309] Dynamic subtest C-DP3: SUCCESS (0.262s) [106.408833] Starting dynamic subtest: D-DP3 [106.642306] Dynamic subtest D-DP3: SUCCESS (0.262s) [106.647066] Subtest nonexisting-fb-interruptible: SUCCESS (1.133s) [107.041970] [039/130] (915s left) kms_busy (extended-modeset-hang-oldfb) [107.246335] Starting subtest: extended-modeset-hang-oldfb [107.248400] Starting dynamic subtest: pipe-A [115.332374] Dynamic subtest pipe-A: SUCCESS (8.084s) [115.346357] Starting dynamic subtest: pipe-D [123.410583] Dynamic subtest pipe-D: SUCCESS (8.073s) [123.413971] Subtest extended-modeset-hang-oldfb: SUCCESS (16.165s) [123.707016] [040/130] (899s left) syncobj_wait (single-wait-all-signaled) [123.780989] Starting subtest: single-wait-all-signaled [123.781943] Subtest single-wait-all-signaled: SUCCESS (0.000s) [123.936875] [041/130] (899s left) api_intel_allocator (open-vm) [124.005285] Starting subtest: open-vm [124.026705] Subtest open-vm: SUCCESS (0.022s) [124.199470] [042/130] (899s left) gem_mmap_gtt (cpuset-basic-small-copy) [124.276331] Subtest cpuset-basic-small-copy: SKIP (0.000s) [124.354740] [043/130] (898s left) gem_exec_flush (basic-uc-ro-default) [124.430451] Subtest basic-uc-ro-default: SKIP (0.000s) [124.519834] [044/130] (898s left) gem_wait (busy) [124.603736] Starting subtest: busy [124.604620] Starting dynamic subtest: all-engines [125.195299] Dynamic subtest all-engines: SUCCESS (0.591s) [125.204438] Starting dynamic subtest: rcs0 [125.734408] Dynamic subtest rcs0: SUCCESS (0.538s) [125.742648] Starting dynamic subtest: bcs0 [126.273345] Dynamic subtest bcs0: SUCCESS (0.538s) [126.281562] Starting dynamic subtest: vcs0 [126.811341] Dynamic subtest vcs0: SUCCESS (0.537s) [126.819566] Starting dynamic subtest: vcs1 [127.350251] Dynamic subtest vcs1: SUCCESS (0.538s) [127.358488] Starting dynamic subtest: vecs0 [127.889375] Dynamic subtest vecs0: SUCCESS (0.539s) [127.897608] Starting dynamic subtest: vecs1 [128.427362] Dynamic subtest vecs1: SUCCESS (0.537s) [128.435564] Starting dynamic subtest: ccs0 [128.965354] Dynamic subtest ccs0: SUCCESS (0.537s) [128.966347] Subtest busy: SUCCESS (4.362s) [129.235744] [045/130] (894s left) perf (global-sseu-config) [129.568820] Starting subtest: global-sseu-config [129.570447] Subtest global-sseu-config: SKIP (0.000s) [129.615185] [046/130] (893s left) gem_userptr_blits (process-exit) [129.703788] Starting subtest: process-exit [129.714735] Subtest process-exit: SUCCESS (0.011s) [129.890070] [047/130] (893s left) kms_flip (bo-too-big) [130.090978] Starting subtest: bo-too-big [130.095167] Starting dynamic subtest: A-DP3 [130.439820] Dynamic subtest A-DP3: SUCCESS (0.344s) [130.475909] Starting dynamic subtest: B-DP3 [130.719344] Dynamic subtest B-DP3: SUCCESS (0.276s) [130.753090] Starting dynamic subtest: C-DP3 [130.996077] Dynamic subtest C-DP3: SUCCESS (0.274s) [131.017986] Starting dynamic subtest: D-DP3 [131.286271] Dynamic subtest D-DP3: SUCCESS (0.288s) [131.290268] Subtest bo-too-big: SUCCESS (1.199s) [131.688802] [048/130] (891s left) kms_ccs (bad-rotation-90-y-tiled-gen12-rc-ccs) [131.886397] Starting subtest: bad-rotation-90-y-tiled-gen12-rc-ccs [131.887280] Starting dynamic subtest: pipe-A-DP-3 [131.895549] Dynamic subtest pipe-A-DP-3: SKIP (0.000s) [131.904193] Starting dynamic subtest: pipe-B-DP-3 [131.912928] Dynamic subtest pipe-B-DP-3: SKIP (0.000s) [131.921039] Starting dynamic subtest: pipe-C-DP-3 [131.929397] Dynamic subtest pipe-C-DP-3: SKIP (0.000s) [131.937137] Starting dynamic subtest: pipe-D-DP-3 [131.947910] Dynamic subtest pipe-D-DP-3: SKIP (0.000s) [131.950128] Subtest bad-rotation-90-y-tiled-gen12-rc-ccs: SKIP (0.005s) [132.356976] [049/130] (891s left) kms_flip (plain-flip-ts-check) [132.557014] Starting subtest: plain-flip-ts-check [132.561039] Starting dynamic subtest: A-DP3 [140.684635] Dynamic subtest A-DP3: SUCCESS (8.123s) [140.696942] Starting dynamic subtest: B-DP3 [148.746576] Dynamic subtest B-DP3: SUCCESS (8.060s) [148.755445] Starting dynamic subtest: C-DP3 [156.792023] Dynamic subtest C-DP3: SUCCESS (8.044s) [156.800971] Starting dynamic subtest: D-DP3 [164.830402] Dynamic subtest D-DP3: SUCCESS (8.037s) [164.832623] Subtest plain-flip-ts-check: SUCCESS (32.275s) [165.201662] [050/130] (858s left) kms_flip (2x-flip-vs-panning-vs-hang) [165.404058] Starting subtest: 2x-flip-vs-panning-vs-hang [165.418595] Subtest 2x-flip-vs-panning-vs-hang: SKIP (0.014s) [165.513119] [051/130] (858s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc) [165.726078] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc [165.727879] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [165.849734] [052/130] (858s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions) [166.047800] Starting subtest: short-flip-after-cursor-atomic-transitions [167.072929] Subtest short-flip-after-cursor-atomic-transitions: SUCCESS (1.024s) [167.336974] [053/130] (856s left) syncobj_wait (multi-wait-submitted-signaled) [167.409705] Starting subtest: multi-wait-submitted-signaled [167.410625] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s) [167.531124] [054/130] (856s left) kms_content_protection (legacy) [167.793956] Starting subtest: legacy [168.070336] Starting dynamic subtest: pipe-A-DP-3 [291.195921] Dynamic subtest pipe-A-DP-3: FAIL (122.859s) [291.196992] Subtest legacy: FAIL (123.230s) [291.311981] [055/130] (732s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf) [291.517917] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s) [291.562717] [056/130] (732s left) gem_flink_race (flink_name) [291.610869] Starting subtest: flink_name [297.010436] Subtest flink_name: SUCCESS (5.398s) [297.142995] [057/130] (727s left) gem_flink_basic (bad-flink) [297.257372] Starting subtest: bad-flink [297.258226] Subtest bad-flink: SUCCESS (0.000s) [297.407958] [058/130] (726s left) kms_selftest (drm_format_helper) [297.464246] Starting subtest: drm_format_helper [297.477778] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8 [297.569620] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.091s) [297.597175] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332 [297.685068] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.112s) [297.715970] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565 [297.814572] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.127s) [297.846202] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555 [297.935848] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.118s) [297.966803] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555 [298.049018] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.109s) [298.080773] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551 [298.164743] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.112s) [298.194641] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888 [298.286069] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.119s) [298.318373] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888 [298.382134] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.092s) [298.412395] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888 [298.483308] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.098s) [298.513120] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010 [298.607281] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.119s) [298.639187] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010 [298.738214] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.129s) [298.771355] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono [298.844698] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.103s) [298.877156] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab [298.945970] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.098s) [298.983401] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888 [299.054089] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.103s) [299.083579] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888 [299.154352] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.097s) [299.189020] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset [299.264506] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.107s) [299.296868] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_build_fourcc_list [299.388666] Dynamic subtest drm_format_helper_test-drm_test_fb_build_fourcc_list: SUCCESS (0.122s) [299.404559] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy [299.503052] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.112s) [299.504506] Subtest drm_format_helper: SUCCESS (2.038s) [299.720140] [059/130] (724s left) kms_pm_rpm (fences) [302.049592] Starting subtest: fences [302.053457] Subtest fences: SKIP (0.000s) [302.414843] [060/130] (721s left) gem_create (create-clear) [302.489325] Starting subtest: create-clear [302.490688] Starting dynamic subtest: lmem0 [336.379484] Dynamic subtest lmem0: SUCCESS (33.873s) [336.388279] Starting dynamic subtest: smem0 [370.336924] Dynamic subtest smem0: SUCCESS (33.968s) [370.337910] Subtest create-clear: SUCCESS (67.843s) [370.783371] [061/130] (653s left) vgem_basic (setversion) [370.909381] Starting subtest: setversion [370.911169] Subtest setversion: SUCCESS (0.000s) [370.984221] [FACT vgem_basic (setversion)] new: kernel.kmod_is_loaded.vgem: true [370.986267] [062/130] (653s left) gem_ctx_engines (independent) [371.075295] Starting subtest: independent [371.076267] Starting dynamic subtest: rcs0 [371.218321] Dynamic subtest rcs0: SUCCESS (0.142s) [371.227210] Starting dynamic subtest: bcs0 [371.354157] Dynamic subtest bcs0: SUCCESS (0.135s) [371.363023] Starting dynamic subtest: vcs0 [371.498526] Dynamic subtest vcs0: SUCCESS (0.144s) [371.507257] Starting dynamic subtest: vcs1 [371.641354] Dynamic subtest vcs1: SUCCESS (0.142s) [371.650143] Starting dynamic subtest: vecs0 [371.783083] Dynamic subtest vecs0: SUCCESS (0.141s) [371.791842] Starting dynamic subtest: vecs1 [371.927558] Dynamic subtest vecs1: SUCCESS (0.144s) [371.936444] Starting dynamic subtest: ccs0 [372.073733] Dynamic subtest ccs0: SUCCESS (0.145s) [372.082522] Starting dynamic subtest: all-engines [372.425911] Dynamic subtest all-engines: SUCCESS (0.351s) [372.426949] Subtest independent: SUCCESS (1.351s) [373.394682] [063/130] (651s left) gem_exec_reloc (basic-wc-gtt-noreloc) [373.481568] Subtest basic-wc-gtt-noreloc: SKIP (0.000s) [373.567273] [064/130] (651s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-mmap-wc) [373.777857] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-mmap-wc [373.779534] Subtest fbcpsr-1p-offscren-pri-indfb-draw-mmap-wc: SKIP (0.000s) [373.925014] [065/130] (650s left) kms_psr (pr-cursor-mmap-gtt) [374.131346] Subtest pr-cursor-mmap-gtt: SKIP (0.000s) [374.197116] [066/130] (650s left) gem_mmap_offset (basic-uaf) [374.287369] Starting subtest: basic-uaf [374.288336] Subtest basic-uaf: SUCCESS (0.001s) [374.454866] [067/130] (650s left) gem_exec_params (cliprects-invalid) [374.538846] Starting subtest: cliprects-invalid [374.539796] Subtest cliprects-invalid: SUCCESS (0.000s) [374.671387] [068/130] (650s left) gem_render_copy (mixed-tiled-to-yf-tiled-ccs) [374.760392] Starting subtest: mixed-tiled-to-yf-tiled-ccs [374.762645] Subtest mixed-tiled-to-yf-tiled-ccs: SKIP (0.000s) [374.985350] [069/130] (649s left) syncobj_wait (single-wait-for-submit-signaled) [375.065987] Starting subtest: single-wait-for-submit-signaled [375.067213] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s) [375.210995] [070/130] (649s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions) [375.416966] Starting subtest: flip-vs-cursor-atomic-transitions [385.460211] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (10.043s) [385.714549] [071/130] (639s left) i915_query (engine-info) [385.793284] Starting subtest: engine-info [385.800560] Subtest engine-info: SUCCESS (0.008s) [385.984851] [072/130] (639s left) gem_softpin (evict-prime) [386.068962] Starting subtest: evict-prime [386.069954] Starting dynamic subtest: rcs0 [387.261797] Dynamic subtest rcs0: SUCCESS (1.192s) [387.271513] Starting dynamic subtest: bcs0 [388.386357] Dynamic subtest bcs0: SUCCESS (1.124s) [388.395526] Starting dynamic subtest: vcs0 [389.537436] Dynamic subtest vcs0: SUCCESS (1.150s) [389.546942] Starting dynamic subtest: vcs1 [390.707677] Dynamic subtest vcs1: SUCCESS (1.169s) [390.719197] Starting dynamic subtest: vecs0 [391.846618] Dynamic subtest vecs0: SUCCESS (1.138s) [391.855837] Starting dynamic subtest: vecs1 [392.990538] Dynamic subtest vecs1: SUCCESS (1.143s) [393.000783] Starting dynamic subtest: ccs0 [394.146495] Dynamic subtest ccs0: SUCCESS (1.155s) [394.159161] Starting dynamic subtest: all [395.266427] Dynamic subtest all: SUCCESS (1.119s) [395.267534] Subtest evict-prime: SUCCESS (9.198s) [395.387546] [073/130] (629s left) gem_exec_whisper (basic-fds-forked-all) [395.497663] Starting subtest: basic-fds-forked-all [418.005399] Subtest basic-fds-forked-all: SUCCESS (22.506s) [418.254730] [074/130] (607s left) sysfs_heartbeat_interval (idempotent) [418.337991] Starting subtest: idempotent [418.338977] Starting dynamic subtest: vecs0 [418.339926] Dynamic subtest vecs0: SUCCESS (0.001s) [418.349491] Starting dynamic subtest: ccs0 [418.350427] Dynamic subtest ccs0: SUCCESS (0.001s) [418.359393] Starting dynamic subtest: vcs0 [418.360303] Dynamic subtest vcs0: SUCCESS (0.001s) [418.369225] Starting dynamic subtest: bcs0 [418.370513] Dynamic subtest bcs0: SUCCESS (0.001s) [418.379489] Starting dynamic subtest: vecs1 [418.380575] Dynamic subtest vecs1: SUCCESS (0.001s) [418.389683] Starting dynamic subtest: rcs0 [418.390916] Dynamic subtest rcs0: SUCCESS (0.001s) [418.399952] Starting dynamic subtest: vcs1 [418.401140] Dynamic subtest vcs1: SUCCESS (0.001s) [418.402404] Subtest idempotent: SUCCESS (0.013s) [418.457342] [075/130] (606s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-blt) [418.668908] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-blt [418.670741] Subtest fbc-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s) [418.832126] [076/130] (606s left) gem_exec_capture (capture) [418.918410] Starting subtest: capture [418.919303] Starting dynamic subtest: rcs0-smem [419.884398] Dynamic subtest rcs0-smem: SUCCESS (0.966s) [419.893771] Starting dynamic subtest: rcs0-lmem0 [420.830433] Dynamic subtest rcs0-lmem0: SUCCESS (0.945s) [420.839701] Starting dynamic subtest: bcs0-smem [422.255418] Dynamic subtest bcs0-smem: SUCCESS (1.424s) [422.264604] Starting dynamic subtest: bcs0-lmem0 [423.302362] Dynamic subtest bcs0-lmem0: SUCCESS (1.047s) [423.311546] Starting dynamic subtest: vcs0-smem [424.201468] Dynamic subtest vcs0-smem: SUCCESS (0.898s) [424.210515] Starting dynamic subtest: vcs0-lmem0 [425.304060] Dynamic subtest vcs0-lmem0: SUCCESS (1.098s) [425.312906] Starting dynamic subtest: vcs1-smem [426.209197] Dynamic subtest vcs1-smem: SUCCESS (0.908s) [426.218241] Starting dynamic subtest: vcs1-lmem0 [427.276255] Dynamic subtest vcs1-lmem0: SUCCESS (1.066s) [427.285182] Starting dynamic subtest: vecs0-smem [428.209723] Dynamic subtest vecs0-smem: FAIL (0.912s) [428.218399] Starting dynamic subtest: vecs0-lmem0 [429.240916] Dynamic subtest vecs0-lmem0: FAIL (1.028s) [429.249645] Starting dynamic subtest: vecs1-smem [430.670742] Dynamic subtest vecs1-smem: FAIL (1.430s) [430.679509] Starting dynamic subtest: vecs1-lmem0 [431.678284] Dynamic subtest vecs1-lmem0: FAIL (1.007s) [431.687184] Starting dynamic subtest: ccs0-smem [433.097301] Dynamic subtest ccs0-smem: SUCCESS (1.441s) [433.106434] Starting dynamic subtest: ccs0-lmem0 [434.033290] Dynamic subtest ccs0-lmem0: SUCCESS (0.935s) [434.034251] Subtest capture: FAIL (15.116s) [434.203035] [077/130] (591s left) gem_exec_suspend (basic-s4-devices) [434.291175] Starting subtest: basic-S4-devices [434.292135] Starting dynamic subtest: smem [444.794033] Dynamic subtest smem: SUCCESS (10.502s) [444.802983] Aborting: Lockdep not active /proc/lockdep_stats contents: lock-classes: 2250 [max: 8192] direct dependencies: 25492 [max: 524288] indirect dependencies: 193797 all direct dependencies: 558266 dependency chains: 39061 [max: 524288] dependency chain hlocks used: 171368 [max: 2621440] dependency chain hlocks lost: 0 in-hardirq chains: 398 in-softirq chains: 922 in-process chains: 37741 stack-trace entries: 269193 [max: 524288] number of stack traces: 12548 number of stack hash chains: 8763 combined max dependencies: 1014608646 hardirq-safe locks: 119 hardirq-unsafe locks: 1342 softirq-safe locks: 261 softirq-unsafe locks: 1236 irq-safe locks: 278 irq-unsafe locks: 1342 hardirq-read-safe locks: 5 hardirq-read-unsafe locks: 406 softirq-read-safe locks: 9 softirq-read-unsafe locks: 401 irq-read-safe locks: 9 irq-read-unsafe locks: 406 uncategorized locks: 360 unused locks: 1 max locking depth: 17 max bfs queue depth: 396 max lock class index: 2249 debug_locks: 0 zapped classes: 3 zapped lock chains: 164 large chain blocks: 1 [444.805231] Starting dynamic subtest: lmem0 [454.081262] Dynamic subtest lmem0: SUCCESS (9.286s) [454.082251] Subtest basic-S4-devices: SUCCESS (19.790s) [454.306597] Closing watchdogs results: parsing output: 0/ for test: kms_psr2_sf results: parsing output: 1/ for test: gen9_exec_parse results: parsing output: 2/ for test: kms_cursor_crc results: parsing output: 3/ for test: kms_getfb results: parsing output: 4/ for test: syncobj_wait results: parsing output: 5/ for test: syncobj_timeline results: parsing output: 6/ for test: kms_flip results: parsing output: 7/ for test: kms_setmode results: parsing output: 8/ for test: kms_psr results: parsing output: 9/ for test: kms_chamelium_hpd results: parsing output: 10/ for test: kms_lease results: parsing output: 11/ for test: kms_writeback results: parsing output: 12/ for test: kms_psr results: parsing output: 13/ for test: gem_spin_batch results: parsing output: 14/ for test: gem_ctx_param results: parsing output: 15/ for test: kms_psr results: parsing output: 16/ for test: kms_plane_scaling results: parsing output: 17/ for test: gem_mmap_gtt results: parsing output: 18/ for test: gem_exec_schedule results: parsing output: 19/ for test: kms_cursor_crc results: parsing output: 20/ for test: kms_color results: parsing output: 21/ for test: kms_ccs results: parsing output: 22/ for test: drm_fdinfo results: parsing output: 23/ for test: kms_flip_event_leak results: parsing output: 24/ for test: kms_cursor_legacy results: parsing output: 25/ for test: kms_frontbuffer_tracking results: parsing output: 26/ for test: gem_exec_balancer results: parsing output: 27/ for test: kms_lease results: parsing output: 28/ for test: syncobj_timeline results: parsing output: 29/ for test: gem_fence_thrash results: parsing output: 30/ for test: kms_plane_scaling results: parsing output: 31/ for test: kms_pipe_crc_basic results: parsing output: 32/ for test: core_setmaster results: parsing output: 33/ for test: kms_pm_rpm results: parsing output: 34/ for test: kms_frontbuffer_tracking results: parsing output: 35/ for test: syncobj_timeline results: parsing output: 36/ for test: drm_fdinfo results: parsing output: 37/ for test: kms_flip results: parsing output: 38/ for test: kms_busy results: parsing output: 39/ for test: syncobj_wait results: parsing output: 40/ for test: api_intel_allocator results: parsing output: 41/ for test: gem_mmap_gtt results: parsing output: 42/ for test: gem_exec_flush results: parsing output: 43/ for test: gem_wait results: parsing output: 44/ for test: perf results: parsing output: 45/ for test: gem_userptr_blits results: parsing output: 46/ for test: kms_flip results: parsing output: 47/ for test: kms_ccs results: parsing output: 48/ for test: kms_flip results: parsing output: 49/ for test: kms_flip results: parsing output: 50/ for test: kms_frontbuffer_tracking results: parsing output: 51/ for test: kms_cursor_legacy results: parsing output: 52/ for test: syncobj_wait results: parsing output: 53/ for test: kms_content_protection results: parsing output: 54/ for test: kms_psr2_sf results: parsing output: 55/ for test: gem_flink_race results: parsing output: 56/ for test: gem_flink_basic results: parsing output: 57/ for test: kms_selftest results: parsing output: 58/ for test: kms_pm_rpm results: parsing output: 59/ for test: gem_create results: parsing output: 60/ for test: vgem_basic results: parsing output: 61/ for test: gem_ctx_engines results: parsing output: 62/ for test: gem_exec_reloc results: parsing output: 63/ for test: kms_frontbuffer_tracking results: parsing output: 64/ for test: kms_psr results: parsing output: 65/ for test: gem_mmap_offset results: parsing output: 66/ for test: gem_exec_params results: parsing output: 67/ for test: gem_render_copy results: parsing output: 68/ for test: syncobj_wait results: parsing output: 69/ for test: kms_cursor_legacy results: parsing output: 70/ for test: i915_query results: parsing output: 71/ for test: gem_softpin results: parsing output: 72/ for test: gem_exec_whisper results: parsing output: 73/ for test: sysfs_heartbeat_interval results: parsing output: 74/ for test: kms_frontbuffer_tracking results: parsing output: 75/ for test: gem_exec_capture results: parsing output: 76/ for test: gem_exec_suspend results: parsing output: 77/ for test: gem_exec_fence results: no output, setting notrun results: parsing output: 78/ for test: gem_pxp results: no output, setting notrun results: parsing output: 79/ for test: kms_plane results: no output, setting notrun results: parsing output: 80/ for test: kms_flip_scaled_crc results: no output, setting notrun results: parsing output: 81/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 82/ for test: i915_module_load results: no output, setting notrun results: parsing output: 83/ for test: kms_ccs results: no output, setting notrun results: parsing output: 84/ for test: gem_exec_reloc results: no output, setting notrun results: parsing output: 85/ for test: gem_eio results: no output, setting notrun results: parsing output: 86/ for test: sw_sync results: no output, setting notrun results: parsing output: 87/ for test: gem_caching results: no output, setting notrun results: parsing output: 88/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 89/ for test: i915_suspend results: no output, setting notrun results: parsing output: 90/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 91/ for test: kms_ccs results: no output, setting notrun results: parsing output: 92/ for test: gem_exec_schedule results: no output, setting notrun results: parsing output: 93/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 94/ for test: gem_ctx_param results: no output, setting notrun results: parsing output: 95/ for test: kms_flip_scaled_crc results: no output, setting notrun results: parsing output: 96/ for test: gem_eio results: no output, setting notrun results: parsing output: 97/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 98/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 99/ for test: kms_cursor_edge_walk results: no output, setting notrun results: parsing output: 100/ for test: kms_psr results: no output, setting notrun results: parsing output: 101/ for test: syncobj_timeline results: no output, setting notrun results: parsing output: 102/ for test: kms_ccs results: no output, setting notrun results: parsing output: 103/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 104/ for test: gem_exec_reloc results: no output, setting notrun results: parsing output: 105/ for test: gem_exec_async results: no output, setting notrun results: parsing output: 106/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 107/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 108/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 109/ for test: kms_draw_crc results: no output, setting notrun results: parsing output: 110/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 111/ for test: gem_lmem_swapping results: no output, setting notrun results: parsing output: 112/ for test: prime_vgem results: no output, setting notrun results: parsing output: 113/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 114/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 115/ for test: sw_sync results: no output, setting notrun results: parsing output: 116/ for test: kms_addfb_basic results: no output, setting notrun results: parsing output: 117/ for test: kms_rotation_crc results: no output, setting notrun results: parsing output: 118/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 119/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 120/ for test: kms_chamelium_edid results: no output, setting notrun results: parsing output: 121/ for test: kms_universal_plane results: no output, setting notrun results: parsing output: 122/ for test: perf_pmu results: no output, setting notrun results: parsing output: 123/ for test: kms_atomic results: no output, setting notrun results: parsing output: 124/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 125/ for test: gem_ctx_persistence results: no output, setting notrun results: parsing output: 126/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 127/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 128/ for test: kms_cursor_legacy results: no output, setting notrun results: parsing output: 129/ for test: gem_mmap_gtt results: no output, setting notrun Done.