[103.720982] Initializing watchdogs [103.721097] /dev/watchdog0 [103.725103] [001/171] (960s left) i915_module_load (load) [103.813314] Starting subtest: load [114.090727] Subtest load: SUCCESS (10.277s) [114.108626] [002/171] (950s left) core_auth (basic-auth) [114.156907] Starting subtest: basic-auth [114.157591] Subtest basic-auth: SUCCESS (0.000s) [119.372465] [003/171] (944s left) debugfs_test (read_all_entries) [119.413844] Starting subtest: read_all_entries [119.714078] Subtest read_all_entries: SUCCESS (0.300s) [123.656291] [004/171] (940s left) debugfs_test (basic-hwmon) [123.703492] Starting subtest: basic-hwmon [123.705281] Subtest basic-hwmon: SKIP (0.000s) [127.606460] [005/171] (936s left) fbdev (eof) [127.655464] Starting subtest: eof [127.656404] Subtest eof: SUCCESS (0.000s) [127.738226] [006/171] (936s left) fbdev (info) [127.774266] Starting subtest: info [127.775050] Subtest info: SUCCESS (0.000s) [127.870547] [007/171] (936s left) fbdev (nullptr) [127.921755] Starting subtest: nullptr [127.922699] Subtest nullptr: SUCCESS (0.000s) [128.003891] [008/171] (936s left) fbdev (read) [128.054921] Starting subtest: read [136.054073] Subtest read: SUCCESS (7.965s) [136.116457] [009/171] (928s left) fbdev (write) [136.166055] Starting subtest: write [141.530870] Subtest write: SUCCESS (5.330s) [141.597491] [010/171] (922s left) gem_basic (bad-close) [141.632414] Starting subtest: bad-close [141.633727] Subtest bad-close: SUCCESS (0.000s) [141.711894] [011/171] (922s left) gem_basic (create-close) [141.747919] Starting subtest: create-close [141.749802] Subtest create-close: SUCCESS (0.000s) [141.846800] [012/171] (922s left) gem_basic (create-fd-close) [141.882806] Starting subtest: create-fd-close [141.884566] Subtest create-fd-close: SUCCESS (0.000s) [141.980465] [013/171] (922s left) gem_busy (busy@all-engines) [142.022389] Starting subtest: busy [142.023305] Starting dynamic subtest: all-engines [142.042852] Dynamic subtest all-engines: SUCCESS (0.021s) [142.043686] Subtest busy: SUCCESS (0.021s) [142.389963] [014/171] (921s left) gem_close_race (basic-process) [142.435230] Starting subtest: basic-process [142.471070] Subtest basic-process: SUCCESS (0.035s) [142.670461] [015/171] (921s left) gem_close_race (basic-threads) [142.711883] Starting subtest: basic-threads [143.923864] Subtest basic-threads: SUCCESS (1.211s) [144.127721] [016/171] (920s left) gem_ctx_create (basic) [144.168330] Starting subtest: basic [144.169185] Subtest basic: SUCCESS (0.000s) [144.367199] [017/171] (920s left) gem_ctx_create (basic-files) [144.407806] Starting subtest: basic-files [146.415826] Subtest basic-files: SUCCESS (2.008s) [146.805447] [018/171] (917s left) gem_ctx_exec (basic) [146.842575] Starting subtest: basic [146.844774] Subtest basic: SUCCESS (0.002s) [146.961198] [019/171] (917s left) gem_exec_basic (basic) [147.007365] Starting subtest: basic [147.009772] Starting dynamic subtest: rcs0-smem [147.010908] Dynamic subtest rcs0-smem: SUCCESS (0.001s) [147.014777] Starting dynamic subtest: bcs0-smem [147.015555] Dynamic subtest bcs0-smem: SUCCESS (0.000s) [147.018974] Starting dynamic subtest: vcs0-smem [147.019827] Dynamic subtest vcs0-smem: SUCCESS (0.000s) [147.023248] Starting dynamic subtest: vcs1-smem [147.024055] Dynamic subtest vcs1-smem: SUCCESS (0.000s) [147.028030] Starting dynamic subtest: vecs0-smem [147.028915] Dynamic subtest vecs0-smem: SUCCESS (0.001s) [147.029816] Subtest basic: SUCCESS (0.002s) [147.202573] [020/171] (917s left) gem_exec_create (basic) [147.243578] Starting subtest: basic [147.244514] Starting dynamic subtest: smem [149.331564] Dynamic subtest smem: SUCCESS (2.088s) [149.333091] Subtest basic: SUCCESS (2.088s) [149.535115] [021/171] (914s left) gem_exec_fence (basic-busy) [149.701558] Starting subtest: basic-busy [149.702860] Starting dynamic subtest: rcs0 [149.748998] Dynamic subtest rcs0: SUCCESS (0.057s) [149.752919] Starting dynamic subtest: bcs0 [149.800448] Dynamic subtest bcs0: SUCCESS (0.051s) [149.811293] Starting dynamic subtest: vcs0 [149.848757] Dynamic subtest vcs0: SUCCESS (0.048s) [149.860536] Starting dynamic subtest: vcs1 [149.904859] Dynamic subtest vcs1: SUCCESS (0.056s) [149.914095] Starting dynamic subtest: vecs0 [149.958553] Dynamic subtest vecs0: SUCCESS (0.054s) [149.960659] Subtest basic-busy: SUCCESS (0.266s) [150.464455] [022/171] (913s left) gem_exec_fence (basic-wait) [150.630946] Starting subtest: basic-wait [150.632144] Starting dynamic subtest: rcs0 [150.702212] Dynamic subtest rcs0: SUCCESS (0.079s) [150.712122] Starting dynamic subtest: bcs0 [150.748765] Dynamic subtest bcs0: SUCCESS (0.046s) [150.760855] Starting dynamic subtest: vcs0 [150.796714] Dynamic subtest vcs0: SUCCESS (0.048s) [150.809534] Starting dynamic subtest: vcs1 [150.846462] Dynamic subtest vcs1: SUCCESS (0.049s) [150.856957] Starting dynamic subtest: vecs0 [150.896106] Dynamic subtest vecs0: SUCCESS (0.049s) [150.898785] Subtest basic-wait: SUCCESS (0.272s) [151.383527] [023/171] (913s left) gem_exec_fence (basic-await) [151.555553] Starting subtest: basic-await [151.556591] Starting dynamic subtest: rcs0 [151.620821] Dynamic subtest rcs0: SUCCESS (0.074s) [151.629639] Starting dynamic subtest: bcs0 [151.691788] Dynamic subtest bcs0: SUCCESS (0.070s) [151.698376] Starting dynamic subtest: vcs0 [151.761793] Dynamic subtest vcs0: SUCCESS (0.071s) [151.770541] Starting dynamic subtest: vcs1 [151.832167] Dynamic subtest vcs1: SUCCESS (0.070s) [151.841935] Starting dynamic subtest: vecs0 [151.904153] Dynamic subtest vecs0: SUCCESS (0.071s) [151.906375] Subtest basic-await: SUCCESS (0.357s) [152.404460] [024/171] (912s left) gem_exec_fence (nb-await) [152.571193] Starting subtest: nb-await [152.572379] Starting dynamic subtest: rcs0 [152.625490] Dynamic subtest rcs0: SUCCESS (0.061s) [152.633241] Starting dynamic subtest: bcs0 [152.684330] Dynamic subtest bcs0: SUCCESS (0.059s) [152.696945] Starting dynamic subtest: vcs0 [152.747995] Dynamic subtest vcs0: SUCCESS (0.064s) [152.760958] Starting dynamic subtest: vcs1 [152.816258] Dynamic subtest vcs1: SUCCESS (0.068s) [152.824738] Starting dynamic subtest: vecs0 [152.876906] Dynamic subtest vecs0: SUCCESS (0.060s) [152.880290] Subtest nb-await: SUCCESS (0.314s) [153.378234] [025/171] (911s left) gem_exec_gttfill (basic) [153.419813] Starting subtest: basic [156.127638] Subtest basic: SUCCESS (2.698s) [156.310645] [026/171] (908s left) gem_exec_parallel (engines) [156.389252] Starting subtest: engines [156.390304] Starting dynamic subtest: basic [157.821045] Dynamic subtest basic: SUCCESS (1.431s) [157.827827] Starting dynamic subtest: contexts [159.595998] Dynamic subtest contexts: SUCCESS (1.765s) [159.600657] Starting dynamic subtest: fds [161.514358] Dynamic subtest fds: SUCCESS (1.919s) [161.519218] Starting dynamic subtest: userptr [162.894483] Dynamic subtest userptr: SUCCESS (1.388s) [162.896573] Subtest engines: SUCCESS (6.504s) [163.095042] [027/171] (901s left) gem_exec_store (basic) [163.137435] Starting subtest: basic [163.215790] Subtest basic: SUCCESS (0.077s) [163.416404] [028/171] (901s left) gem_flink_basic (bad-flink) [163.454066] Starting subtest: bad-flink [163.454908] Subtest bad-flink: SUCCESS (0.000s) [163.529302] [029/171] (900s left) gem_flink_basic (bad-open) [163.566057] Starting subtest: bad-open [163.567108] Subtest bad-open: SUCCESS (0.000s) [163.645978] [030/171] (900s left) gem_flink_basic (basic) [163.681933] Starting subtest: basic [163.682786] Subtest basic: SUCCESS (0.000s) [163.784542] [031/171] (900s left) gem_flink_basic (double-flink) [163.821803] Starting subtest: double-flink [163.822715] Subtest double-flink: SUCCESS (0.000s) [163.915397] [032/171] (900s left) gem_flink_basic (flink-lifetime) [163.951327] Starting subtest: flink-lifetime [163.952048] Subtest flink-lifetime: SUCCESS (0.001s) [164.047641] [033/171] (900s left) gem_huc_copy (huc-copy) [164.087955] Starting subtest: huc-copy [164.089880] Subtest huc-copy: SUCCESS (0.002s) [164.196426] [034/171] (900s left) gem_linear_blits (basic) [164.298147] Starting subtest: basic [164.302460] Subtest basic: SUCCESS (0.005s) [164.448921] [035/171] (900s left) gem_mmap (basic) [164.517589] Starting subtest: basic [164.521534] Subtest basic: SUCCESS (0.001s) [164.626947] [036/171] (899s left) gem_mmap_gtt (basic) [164.663562] Starting subtest: basic [164.664440] Subtest basic: SUCCESS (0.000s) [164.732221] [037/171] (899s left) gem_render_linear_blits (basic) [164.772187] Starting subtest: basic [164.790097] Subtest basic: SUCCESS (0.018s) [164.880173] [038/171] (899s left) gem_render_tiled_blits (basic) [164.918231] Starting subtest: basic [164.944940] Subtest basic: SUCCESS (0.027s) [165.033341] [039/171] (899s left) gem_ringfill (basic-all) [165.370736] Starting subtest: basic-all [166.508069] Subtest basic-all: SUCCESS (1.132s) [166.631514] [040/171] (898s left) gem_softpin (allocator-basic) [166.671839] Starting subtest: allocator-basic [166.719335] Subtest allocator-basic: SUCCESS (0.047s) [166.844740] [041/171] (897s left) gem_softpin (allocator-basic-reserve) [166.884979] Starting subtest: allocator-basic-reserve [166.929245] Subtest allocator-basic-reserve: SUCCESS (0.044s) [167.064430] [042/171] (897s left) gem_softpin (safe-alignment) [167.103209] Starting subtest: safe-alignment [167.109819] Subtest safe-alignment: SUCCESS (0.007s) [167.233611] [043/171] (897s left) gem_sync (basic-all) [167.275942] Starting subtest: basic-all [169.716585] Subtest basic-all: SUCCESS (2.440s) [169.925374] [044/171] (894s left) gem_sync (basic-each) [169.969086] Starting subtest: basic-each [172.189655] Subtest basic-each: SUCCESS (2.221s) [172.392214] [045/171] (892s left) gem_tiled_blits (basic) [172.486888] Starting subtest: basic [172.495977] Subtest basic: SUCCESS (0.010s) [172.642313] [046/171] (892s left) gem_tiled_fence_blits (basic) [172.768187] Starting subtest: basic [172.840138] Subtest basic: SUCCESS (0.072s) [172.968672] [047/171] (891s left) gem_tiled_pread_basic [173.097690] [048/171] (891s left) gem_wait (busy@all-engines) [173.141517] Starting subtest: busy [173.142256] Starting dynamic subtest: all-engines [173.691129] Dynamic subtest all-engines: SUCCESS (0.548s) [173.692633] Subtest busy: SUCCESS (0.549s) [173.912267] [049/171] (890s left) gem_wait (wait@all-engines) [173.955969] Starting subtest: wait [173.956829] Starting dynamic subtest: all-engines [175.005520] Dynamic subtest all-engines: SUCCESS (1.048s) [175.007537] Subtest wait: SUCCESS (1.048s) [175.232680] [050/171] (889s left) i915_getparams_basic (basic-eu-total) [175.269522] Starting subtest: basic-eu-total [175.271308] Subtest basic-eu-total: SUCCESS (0.000s) [175.359583] [051/171] (889s left) i915_getparams_basic (basic-subslice-total) [175.397747] Starting subtest: basic-subslice-total [175.399449] Subtest basic-subslice-total: SUCCESS (0.000s) [175.478570] [052/171] (889s left) i915_hangman (error-state-basic) [175.520160] Starting subtest: error-state-basic [175.731895] Subtest error-state-basic: SUCCESS (0.212s) [175.826982] [053/171] (888s left) i915_pciid [175.942103] [054/171] (888s left) kms_addfb_basic (addfb25-bad-modifier) [175.979227] Starting subtest: addfb25-bad-modifier [175.980021] Subtest addfb25-bad-modifier: SUCCESS (0.000s) [179.844535] [055/171] (884s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [179.881101] Starting subtest: addfb25-framebuffer-vs-set-tiling [179.881837] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s) [183.752333] [056/171] (881s left) kms_addfb_basic (addfb25-modifier-no-flag) [183.788026] Starting subtest: addfb25-modifier-no-flag [183.788892] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [187.668654] [057/171] (877s left) kms_addfb_basic (addfb25-x-tiled-legacy) [187.705302] Starting subtest: addfb25-x-tiled-legacy [187.706034] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s) [191.568662] [058/171] (873s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy) [191.605639] Starting subtest: addfb25-x-tiled-mismatch-legacy [191.606523] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s) [195.474551] [059/171] (869s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [199.277134] Starting subtest: addfb25-yf-tiled-legacy [199.278109] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [199.373808] [060/171] (865s left) kms_addfb_basic (addfb25-y-tiled-legacy) [203.174447] Starting subtest: addfb25-y-tiled-legacy [203.175297] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s) [203.275568] [061/171] (861s left) kms_addfb_basic (addfb25-y-tiled-small-legacy) [207.067536] Starting subtest: addfb25-y-tiled-small-legacy [207.068541] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.000s) [207.170045] [062/171] (857s left) kms_addfb_basic (bad-pitch-0) [207.206719] Starting subtest: bad-pitch-0 [207.207759] Subtest bad-pitch-0: SUCCESS (0.000s) [211.078494] [063/171] (853s left) kms_addfb_basic (bad-pitch-1024) [211.115358] Starting subtest: bad-pitch-1024 [211.116298] Subtest bad-pitch-1024: SUCCESS (0.000s) [214.991932] [064/171] (849s left) kms_addfb_basic (bad-pitch-128) [215.028583] Starting subtest: bad-pitch-128 [215.029601] Subtest bad-pitch-128: SUCCESS (0.000s) [218.896351] [065/171] (846s left) kms_addfb_basic (bad-pitch-256) [218.932417] Starting subtest: bad-pitch-256 [218.933302] Subtest bad-pitch-256: SUCCESS (0.000s) [222.805569] [066/171] (842s left) kms_addfb_basic (bad-pitch-32) [222.842752] Starting subtest: bad-pitch-32 [222.843785] Subtest bad-pitch-32: SUCCESS (0.000s) [226.710810] [067/171] (838s left) kms_addfb_basic (bad-pitch-63) [226.748891] Starting subtest: bad-pitch-63 [226.749743] Subtest bad-pitch-63: SUCCESS (0.000s) [230.622960] [068/171] (834s left) kms_addfb_basic (bad-pitch-65536) [230.658808] Starting subtest: bad-pitch-65536 [230.659793] Subtest bad-pitch-65536: SUCCESS (0.000s) [234.539593] [069/171] (830s left) kms_addfb_basic (bad-pitch-999) [234.576967] Starting subtest: bad-pitch-999 [234.577810] Subtest bad-pitch-999: SUCCESS (0.000s) [238.445330] [070/171] (826s left) kms_addfb_basic (basic) [238.481877] Starting subtest: basic [238.482719] Subtest basic: SUCCESS (0.000s) [242.355522] [071/171] (822s left) kms_addfb_basic (basic-x-tiled-legacy) [242.392984] Starting subtest: basic-x-tiled-legacy [242.393826] Subtest basic-x-tiled-legacy: SUCCESS (0.000s) [246.275275] [072/171] (818s left) kms_addfb_basic (basic-y-tiled-legacy) [246.311592] Starting subtest: basic-y-tiled-legacy [246.312513] Subtest basic-y-tiled-legacy: SUCCESS (0.000s) [250.183919] [073/171] (814s left) kms_addfb_basic (bo-too-small) [253.984779] Starting subtest: bo-too-small [253.985582] Subtest bo-too-small: SUCCESS (0.000s) [254.090960] [074/171] (810s left) kms_addfb_basic (bo-too-small-due-to-tiling) [257.895308] Starting subtest: bo-too-small-due-to-tiling [257.896242] Subtest bo-too-small-due-to-tiling: SUCCESS (0.000s) [258.009266] [075/171] (807s left) kms_addfb_basic (clobberred-modifier) [258.045037] Starting subtest: clobberred-modifier [258.046013] Subtest clobberred-modifier: SUCCESS (0.000s) [261.920719] [076/171] (803s left) kms_addfb_basic (framebuffer-vs-set-tiling) [261.958061] Starting subtest: framebuffer-vs-set-tiling [261.959105] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s) [265.834444] [077/171] (799s left) kms_addfb_basic (invalid-get-prop) [265.872682] Starting subtest: invalid-get-prop [265.873493] Subtest invalid-get-prop: SUCCESS (0.000s) [269.735322] [078/171] (795s left) kms_addfb_basic (invalid-get-prop-any) [269.770927] Starting subtest: invalid-get-prop-any [269.771741] Subtest invalid-get-prop-any: SUCCESS (0.000s) [273.638587] [079/171] (791s left) kms_addfb_basic (invalid-set-prop) [273.675145] Starting subtest: invalid-set-prop [273.675906] Subtest invalid-set-prop: SUCCESS (0.000s) [277.557572] [080/171] (787s left) kms_addfb_basic (invalid-set-prop-any) [277.593132] Starting subtest: invalid-set-prop-any [277.593853] Subtest invalid-set-prop-any: SUCCESS (0.000s) [281.455867] [081/171] (783s left) kms_addfb_basic (no-handle) [281.491113] Starting subtest: no-handle [281.491813] Subtest no-handle: SUCCESS (0.000s) [285.358849] [082/171] (779s left) kms_addfb_basic (size-max) [289.162060] Starting subtest: size-max [289.162852] Subtest size-max: SUCCESS (0.000s) [289.266953] [083/171] (775s left) kms_addfb_basic (small-bo) [293.068180] Starting subtest: small-bo [293.068952] Subtest small-bo: SUCCESS (0.000s) [293.183275] [084/171] (771s left) kms_addfb_basic (tile-pitch-mismatch) [293.222075] Starting subtest: tile-pitch-mismatch [293.222920] Subtest tile-pitch-mismatch: SUCCESS (0.000s) [297.079966] [085/171] (768s left) kms_addfb_basic (too-high) [300.881543] Starting subtest: too-high [300.882562] Subtest too-high: SUCCESS (0.000s) [300.983044] [086/171] (764s left) kms_addfb_basic (too-wide) [304.785020] Starting subtest: too-wide [304.785945] Subtest too-wide: SUCCESS (0.000s) [304.893521] [087/171] (760s left) kms_addfb_basic (unused-handle) [304.930608] Starting subtest: unused-handle [304.931477] Subtest unused-handle: SUCCESS (0.000s) [308.807239] [088/171] (756s left) kms_addfb_basic (unused-modifier) [308.845179] Starting subtest: unused-modifier [308.845906] Subtest unused-modifier: SUCCESS (0.000s) [312.694562] [089/171] (752s left) kms_addfb_basic (unused-offsets) [312.730930] Starting subtest: unused-offsets [312.731839] Subtest unused-offsets: SUCCESS (0.000s) [316.605220] [090/171] (748s left) kms_addfb_basic (unused-pitches) [316.642124] Starting subtest: unused-pitches [316.643049] Subtest unused-pitches: SUCCESS (0.000s) [320.494812] [091/171] (744s left) kms_busy (basic) [324.305920] Starting subtest: basic [324.306985] Starting dynamic subtest: flip [326.294156] Dynamic subtest flip: SUCCESS (1.989s) [326.301047] Starting dynamic subtest: modeset [330.024880] Dynamic subtest modeset: SUCCESS (3.729s) [330.028939] Subtest basic: SUCCESS (5.719s) [331.068934] [092/171] (734s left) kms_chamelium_hpd (dp-hpd-fast) [335.212733] Subtest dp-hpd-fast: SKIP (0.000s) [336.148719] [093/171] (729s left) kms_chamelium_edid (dp-edid-read) [340.296556] Subtest dp-edid-read: SKIP (0.000s) [341.228828] [094/171] (723s left) kms_chamelium_frames (dp-crc-fast) [345.376403] Subtest dp-crc-fast: SKIP (0.000s) [346.311271] [095/171] (718s left) kms_chamelium_hpd (hdmi-hpd-fast) [350.477556] Subtest hdmi-hpd-fast: SKIP (0.000s) [351.395955] [096/171] (713s left) kms_chamelium_edid (hdmi-edid-read) [355.544666] Subtest hdmi-edid-read: SKIP (0.000s) [356.477488] [097/171] (708s left) kms_chamelium_frames (hdmi-crc-fast) [360.627289] Subtest hdmi-crc-fast: SKIP (0.000s) [361.554555] [098/171] (703s left) kms_chamelium_hpd (vga-hpd-fast) [365.703135] Subtest vga-hpd-fast: SKIP (0.000s) [366.627417] [099/171] (698s left) kms_chamelium_edid (vga-edid-read) [370.778774] Subtest vga-edid-read: SKIP (0.000s) [371.714724] [100/171] (693s left) kms_prop_blob (basic) [371.753883] Starting subtest: basic [371.754717] Subtest basic: SUCCESS (0.000s) [371.834721] [101/171] (693s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic) [375.660133] Starting subtest: basic-busy-flip-before-cursor-atomic [375.661587] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s) [375.776122] [102/171] (689s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [379.598049] Starting subtest: basic-busy-flip-before-cursor-legacy [379.599857] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [379.717801] [103/171] (685s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [383.550123] Starting subtest: basic-flip-after-cursor-atomic [385.912961] Subtest basic-flip-after-cursor-atomic: SUCCESS (2.364s) [386.936510] [104/171] (678s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [390.770783] Starting subtest: basic-flip-after-cursor-legacy [393.148986] Subtest basic-flip-after-cursor-legacy: SUCCESS (2.378s) [394.233316] [105/171] (671s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size) [398.062543] Starting subtest: basic-flip-after-cursor-varying-size [400.440249] Subtest basic-flip-after-cursor-varying-size: SUCCESS (2.378s) [401.526589] [106/171] (663s left) kms_cursor_legacy (basic-flip-before-cursor-atomic) [405.351638] Starting subtest: basic-flip-before-cursor-atomic [407.678118] Subtest basic-flip-before-cursor-atomic: SUCCESS (2.327s) [408.758071] [107/171] (656s left) kms_cursor_legacy (basic-flip-before-cursor-legacy) [412.589112] Starting subtest: basic-flip-before-cursor-legacy [414.975321] Subtest basic-flip-before-cursor-legacy: SUCCESS (2.386s) [416.054433] [108/171] (649s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size) [419.877187] Starting subtest: basic-flip-before-cursor-varying-size [422.202333] Subtest basic-flip-before-cursor-varying-size: SUCCESS (2.325s) [423.289142] [109/171] (642s left) kms_flip (basic-flip-vs-dpms) [425.231207] Starting subtest: basic-flip-vs-dpms [425.233727] Starting dynamic subtest: A-eDP1 [427.950108] Dynamic subtest A-eDP1: SUCCESS (2.717s) [427.957768] Starting dynamic subtest: B-eDP1 [430.315131] Dynamic subtest B-eDP1: SUCCESS (2.364s) [430.319834] Starting dynamic subtest: C-eDP1 [432.634266] Dynamic subtest C-eDP1: SUCCESS (2.318s) [432.639061] Starting dynamic subtest: D-eDP1 [434.983316] Dynamic subtest D-eDP1: SUCCESS (2.349s) [434.990383] Starting dynamic subtest: A-DP3 [435.783280] Dynamic subtest A-DP3: SUCCESS (0.799s) [435.790918] Starting dynamic subtest: B-DP3 [436.508572] Dynamic subtest B-DP3: SUCCESS (0.725s) [436.513580] Starting dynamic subtest: C-DP3 [437.242549] Dynamic subtest C-DP3: SUCCESS (0.733s) [437.247573] Starting dynamic subtest: D-DP3 [437.973545] Dynamic subtest D-DP3: SUCCESS (0.731s) [437.974310] Subtest basic-flip-vs-dpms: SUCCESS (12.743s) [438.454234] [110/171] (626s left) kms_flip (basic-flip-vs-modeset) [440.400682] Starting subtest: basic-flip-vs-modeset [440.402447] Starting dynamic subtest: A-eDP1 [443.110141] Dynamic subtest A-eDP1: SUCCESS (2.707s) [443.115054] Starting dynamic subtest: B-eDP1 [445.484303] Dynamic subtest B-eDP1: SUCCESS (2.374s) [445.489045] Starting dynamic subtest: C-eDP1 [447.799855] Dynamic subtest C-eDP1: SUCCESS (2.314s) [447.804675] Starting dynamic subtest: D-eDP1 [450.148241] Dynamic subtest D-eDP1: SUCCESS (2.349s) [450.153053] Starting dynamic subtest: A-DP3 [450.928579] Dynamic subtest A-DP3: SUCCESS (0.780s) [450.933478] Starting dynamic subtest: B-DP3 [451.659646] Dynamic subtest B-DP3: SUCCESS (0.730s) [451.664680] Starting dynamic subtest: C-DP3 [452.390894] Dynamic subtest C-DP3: SUCCESS (0.731s) [452.395988] Starting dynamic subtest: D-DP3 [453.122982] Dynamic subtest D-DP3: SUCCESS (0.732s) [453.123860] Subtest basic-flip-vs-modeset: SUCCESS (12.724s) [453.607689] [111/171] (611s left) kms_flip (basic-flip-vs-wf_vblank) [455.564273] Starting subtest: basic-flip-vs-wf_vblank [455.566752] Starting dynamic subtest: A-eDP1 [457.607728] Dynamic subtest A-eDP1: SUCCESS (2.041s) [457.615845] Starting dynamic subtest: B-eDP1 [459.648295] Dynamic subtest B-eDP1: SUCCESS (2.040s) [459.657108] Starting dynamic subtest: C-eDP1 [461.673568] Dynamic subtest C-eDP1: SUCCESS (2.025s) [461.678397] Starting dynamic subtest: D-eDP1 [463.723114] Dynamic subtest D-eDP1: SUCCESS (2.049s) [463.728205] Starting dynamic subtest: A-DP3 [465.044731] Dynamic subtest A-DP3: SUCCESS (1.320s) [465.053821] Starting dynamic subtest: B-DP3 [466.125066] Dynamic subtest B-DP3: SUCCESS (1.079s) [466.130465] Starting dynamic subtest: C-DP3 [467.192979] Dynamic subtest C-DP3: SUCCESS (1.068s) [467.198106] Starting dynamic subtest: D-DP3 [468.261324] Dynamic subtest D-DP3: SUCCESS (1.067s) [468.262065] Subtest basic-flip-vs-wf_vblank: SUCCESS (12.697s) [468.800389] [112/171] (596s left) kms_flip (basic-plain-flip) [470.794514] Starting subtest: basic-plain-flip [470.797049] Starting dynamic subtest: A-eDP1 [472.570377] Dynamic subtest A-eDP1: SUCCESS (1.774s) [472.576687] Starting dynamic subtest: B-eDP1 [474.339717] Dynamic subtest B-eDP1: SUCCESS (1.768s) [474.347729] Starting dynamic subtest: C-eDP1 [476.112771] Dynamic subtest C-eDP1: SUCCESS (1.772s) [476.117882] Starting dynamic subtest: D-eDP1 [477.838694] Dynamic subtest D-eDP1: SUCCESS (1.726s) [477.843903] Starting dynamic subtest: A-DP3 [478.880509] Dynamic subtest A-DP3: SUCCESS (1.039s) [478.887658] Starting dynamic subtest: B-DP3 [479.649018] Dynamic subtest B-DP3: SUCCESS (0.768s) [479.653902] Starting dynamic subtest: C-DP3 [480.428768] Dynamic subtest C-DP3: SUCCESS (0.779s) [480.433956] Starting dynamic subtest: D-DP3 [481.198468] Dynamic subtest D-DP3: SUCCESS (0.770s) [481.199220] Subtest basic-plain-flip: SUCCESS (10.406s) [481.734486] [113/171] (583s left) kms_force_connector_basic (force-connector-state) [481.774421] Starting subtest: force-connector-state [486.339708] Subtest force-connector-state: SUCCESS (4.565s) [491.124952] [114/171] (574s left) kms_force_connector_basic (force-edid) [491.162458] Starting subtest: force-edid [491.199631] Subtest force-edid: SUCCESS (0.036s) [495.130717] [115/171] (570s left) kms_force_connector_basic (force-load-detect) [495.167861] Starting subtest: force-load-detect [495.169489] Subtest force-load-detect: SKIP (0.000s) [497.171153] [116/171] (568s left) kms_force_connector_basic (prune-stale-modes) [497.208468] Starting subtest: prune-stale-modes [497.244124] Subtest prune-stale-modes: SUCCESS (0.035s) [501.169755] [117/171] (564s left) kms_frontbuffer_tracking (basic) [504.973881] Starting subtest: basic [509.960699] Subtest basic: SUCCESS (4.987s) [511.352489] [118/171] (554s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24) [515.170250] Starting subtest: compare-crc-sanitycheck-xr24 [515.170964] Starting dynamic subtest: pipe-A-eDP-1 [517.093588] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.921s) [517.098617] Starting dynamic subtest: pipe-B-DP-3 [517.637975] Dynamic subtest pipe-B-DP-3: SUCCESS (0.544s) [517.643026] Starting dynamic subtest: pipe-C-DP-3 [518.093087] Dynamic subtest pipe-C-DP-3: SUCCESS (0.454s) [518.098212] Starting dynamic subtest: pipe-D-DP-3 [518.548992] Dynamic subtest pipe-D-DP-3: SUCCESS (0.455s) [518.549790] Subtest compare-crc-sanitycheck-xr24: SUCCESS (3.379s) [519.016793] [119/171] (546s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12) [522.840929] Starting subtest: compare-crc-sanitycheck-nv12 [522.842900] Starting dynamic subtest: pipe-A-eDP-1 [525.288388] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.446s) [525.293331] Starting dynamic subtest: pipe-B-DP-3 [526.241512] Dynamic subtest pipe-B-DP-3: SUCCESS (0.952s) [526.246555] Starting dynamic subtest: pipe-C-DP-3 [527.098121] Dynamic subtest pipe-C-DP-3: SUCCESS (0.855s) [527.103118] Starting dynamic subtest: pipe-D-DP-3 [527.947121] Dynamic subtest pipe-D-DP-3: SUCCESS (0.848s) [527.948120] Subtest compare-crc-sanitycheck-nv12: SUCCESS (5.106s) [528.425493] [120/171] (537s left) kms_pipe_crc_basic (hang-read-crc) [532.252939] Starting subtest: hang-read-crc [532.254115] Starting dynamic subtest: pipe-A-eDP-1 [535.756072] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.503s) [535.762410] Starting dynamic subtest: pipe-B-DP-3 [537.128897] Dynamic subtest pipe-B-DP-3: SUCCESS (1.371s) [537.133834] Starting dynamic subtest: pipe-C-DP-3 [538.425573] Dynamic subtest pipe-C-DP-3: SUCCESS (1.295s) [538.430709] Starting dynamic subtest: pipe-D-DP-3 [539.723997] Dynamic subtest pipe-D-DP-3: SUCCESS (1.298s) [539.724946] Subtest hang-read-crc: SUCCESS (7.472s) [540.179581] [121/171] (525s left) kms_pipe_crc_basic (nonblocking-crc) [544.033145] Starting subtest: nonblocking-crc [544.034045] Starting dynamic subtest: pipe-A-eDP-1 [546.089720] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.055s) [546.094764] Starting dynamic subtest: pipe-B-DP-3 [546.805011] Dynamic subtest pipe-B-DP-3: SUCCESS (0.715s) [546.810287] Starting dynamic subtest: pipe-C-DP-3 [547.433792] Dynamic subtest pipe-C-DP-3: SUCCESS (0.627s) [547.440934] Starting dynamic subtest: pipe-D-DP-3 [548.054745] Dynamic subtest pipe-D-DP-3: SUCCESS (0.621s) [548.055688] Subtest nonblocking-crc: SUCCESS (4.022s) [548.516824] [122/171] (517s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence) [552.318223] Starting subtest: nonblocking-crc-frame-sequence [552.319018] Starting dynamic subtest: pipe-A-eDP-1 [554.353974] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.036s) [554.360157] Starting dynamic subtest: pipe-B-DP-3 [555.056426] Dynamic subtest pipe-B-DP-3: SUCCESS (0.700s) [555.061338] Starting dynamic subtest: pipe-C-DP-3 [555.681894] Dynamic subtest pipe-C-DP-3: SUCCESS (0.625s) [555.686909] Starting dynamic subtest: pipe-D-DP-3 [556.296337] Dynamic subtest pipe-D-DP-3: SUCCESS (0.614s) [556.297198] Subtest nonblocking-crc-frame-sequence: SUCCESS (3.979s) [556.755751] [123/171] (508s left) kms_pipe_crc_basic (read-crc) [560.562659] Starting subtest: read-crc [560.563489] Starting dynamic subtest: pipe-A-eDP-1 [562.588054] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.025s) [562.593831] Starting dynamic subtest: pipe-B-DP-3 [563.238073] Dynamic subtest pipe-B-DP-3: SUCCESS (0.648s) [563.243083] Starting dynamic subtest: pipe-C-DP-3 [563.800015] Dynamic subtest pipe-C-DP-3: SUCCESS (0.561s) [563.805116] Starting dynamic subtest: pipe-D-DP-3 [564.348692] Dynamic subtest pipe-D-DP-3: SUCCESS (0.548s) [564.349546] Subtest read-crc: SUCCESS (3.786s) [564.806405] [124/171] (500s left) kms_pipe_crc_basic (read-crc-frame-sequence) [568.614726] Starting subtest: read-crc-frame-sequence [568.615587] Starting dynamic subtest: pipe-A-eDP-1 [570.614415] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.999s) [570.618204] Aborting: Lockdep not active /proc/lockdep_stats contents: lock-classes: 1810 [max: 8192] direct dependencies: 18206 [max: 32768] indirect dependencies: 138588 all direct dependencies: 388391 dependency chains: 27360 [max: 131072] dependency chain hlocks used: 120120 [max: 655360] dependency chain hlocks lost: 0 in-hardirq chains: 292 in-softirq chains: 646 in-process chains: 26422 stack-trace entries: 166642 [max: 1048576] number of stack traces: 8668 number of stack hash chains: 6731 combined max dependencies: 714067237 hardirq-safe locks: 108 hardirq-unsafe locks: 1073 softirq-safe locks: 214 softirq-unsafe locks: 984 irq-safe locks: 237 irq-unsafe locks: 1073 hardirq-read-safe locks: 3 hardirq-read-unsafe locks: 331 softirq-read-safe locks: 7 softirq-read-unsafe locks: 326 irq-read-safe locks: 7 irq-read-unsafe locks: 331 uncategorized locks: 283 unused locks: 1 max locking depth: 16 max bfs queue depth: 410 max lock class index: 1809 chain lookup misses: 27837 chain lookup hits: 721104937 cyclic checks: 27796 redundant checks: 0 redundant links: 0 find-mask forwards checks: 4917 find-mask backwards checks: 2716 hardirq on events: 354886774 hardirq off events: 354886758 redundant hardirq ons: 52 redundant hardirq offs: 29 softirq on events: 2594703 softirq off events: 2594703 redundant softirq ons: 0 redundant softirq offs: 0 debug_locks: 0 zapped classes: 1 zapped lock chains: 117 large chain blocks: 1 [570.619763] Starting dynamic subtest: pipe-B-DP-3 [571.263931] Dynamic subtest pipe-B-DP-3: SUCCESS (0.648s) [571.264964] Starting dynamic subtest: pipe-C-DP-3 [571.829753] Dynamic subtest pipe-C-DP-3: SUCCESS (0.565s) [571.830484] Starting dynamic subtest: pipe-D-DP-3 [572.393823] Dynamic subtest pipe-D-DP-3: SUCCESS (0.563s) [572.394573] Subtest read-crc-frame-sequence: SUCCESS (3.779s) [572.845678] Closing watchdogs Done.