Results for igt@kms_flip@flip-vs-expired-vblank-interruptible@a-hdmi-a1

Result: Fail

git-log-oneline i915_display_info1 igt_runner1 runtimes1 results1.json results1-i915-load.json guc_logs1.tar i915_display_info_post_exec1 boot1 dmesg1

DetailValue
Duration 5.24 seconds
Hostname
shard-glk9
Igt-Version
IGT-Version: 2.3-geac3b04d1 (x86_64) (Linux: 7.0.0-rc2-CI_DRM_18100-gce63d46cc8fc+ x86_64)
Out
Using IGT_SRANDOM=1772841339 for randomisation
Opened device: /dev/dri/card0
Using monotonic timestamps
Starting subtest: flip-vs-expired-vblank-interruptible
Starting dynamic subtest: A-HDMI-A1
  1920x1080: 60 148500 1920 2008 2052 2200 1080 1083 1088 1125 0x48 0x9 
Stack trace:
  #0 ../lib/igt_core.c:2075 __igt_fail_assert()
  #1 ../tests/kms_flip.c:921 run_test_on_crtc_set.constprop.0()
  #2 ../tests/kms_flip.c:1887 run_test()
  #3 ../tests/kms_flip.c:2156 __igt_unique____real_main2043()
  #4 ../tests/kms_flip.c:2043 main()
  #5 [__libc_init_first+0x8a]
  #6 [__libc_start_main+0x8b]
  #7 [_start+0x25]
Dynamic subtest A-HDMI-A1: FAIL (5.238s)
Err
Starting subtest: flip-vs-expired-vblank-interruptible
Starting dynamic subtest: A-HDMI-A1
(kms_flip:2444) CRITICAL: Test assertion failure function run_test_step, file ../tests/kms_flip.c:926:
(kms_flip:2444) CRITICAL: Failed assertion: end - start < 500
(kms_flip:2444) CRITICAL: Last errno: 4, Interrupted system call
Dynamic subtest A-HDMI-A1 failed.
**** DEBUG ****
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 377.979370
last_received_ts = 377.978882
last_seq = 16083
current_ts = 377.996033
current_received_ts = 377.995605
current_seq = 16084
count = 142
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 377.996033
last_received_ts = 377.995605
last_seq = 16084
current_ts = 378.012695
current_received_ts = 378.012543
current_seq = 16085
count = 143
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.012695
last_received_ts = 378.012543
last_seq = 16085
current_ts = 378.029358
current_received_ts = 378.029236
current_seq = 16086
count = 144
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.029358
last_received_ts = 378.029236
last_seq = 16086
current_ts = 378.046021
current_received_ts = 378.045532
current_seq = 16087
count = 145
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.046021
last_received_ts = 378.045532
last_seq = 16087
current_ts = 378.062683
current_received_ts = 378.062958
current_seq = 16088
count = 146
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 41us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.062683
last_received_ts = 378.062958
last_seq = 16088
current_ts = 378.079376
current_received_ts = 378.079315
current_seq = 16089
count = 147
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.079376
last_received_ts = 378.079315
last_seq = 16089
current_ts = 378.096039
current_received_ts = 378.095612
current_seq = 16090
count = 148
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.096039
last_received_ts = 378.095612
last_seq = 16090
current_ts = 378.112701
current_received_ts = 378.112152
current_seq = 16091
count = 149
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 17us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.112701
last_received_ts = 378.112152
last_seq = 16091
current_ts = 378.129364
current_received_ts = 378.129578
current_seq = 16092
count = 150
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.129364
last_received_ts = 378.129578
last_seq = 16092
current_ts = 378.146027
current_received_ts = 378.145538
current_seq = 16093
count = 151
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.146027
last_received_ts = 378.145538
last_seq = 16093
current_ts = 378.162689
current_received_ts = 378.162445
current_seq = 16094
count = 152
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.162689
last_received_ts = 378.162445
last_seq = 16094
current_ts = 378.179352
current_received_ts = 378.179169
current_seq = 16095
count = 153
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.179352
last_received_ts = 378.179169
last_seq = 16095
current_ts = 378.196014
current_received_ts = 378.195953
current_seq = 16096
count = 154
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.196014
last_received_ts = 378.195953
last_seq = 16096
current_ts = 378.212708
current_received_ts = 378.212860
current_seq = 16097
count = 155
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.212708
last_received_ts = 378.212860
last_seq = 16097
current_ts = 378.229340
current_received_ts = 378.228882
current_seq = 16098
count = 156
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.229340
last_received_ts = 378.228882
last_seq = 16098
current_ts = 378.246033
current_received_ts = 378.245605
current_seq = 16099
count = 157
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.246033
last_received_ts = 378.245605
last_seq = 16099
current_ts = 378.262695
current_received_ts = 378.262817
current_seq = 16100
count = 158
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.262695
last_received_ts = 378.262817
last_seq = 16100
current_ts = 378.279358
current_received_ts = 378.279205
current_seq = 16101
count = 159
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 24us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.279358
last_received_ts = 378.279205
last_seq = 16101
current_ts = 378.296021
current_received_ts = 378.295563
current_seq = 16102
count = 160
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.296021
last_received_ts = 378.295563
last_seq = 16102
current_ts = 378.312683
current_received_ts = 378.312958
current_seq = 16103
count = 161
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 32us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.312683
last_received_ts = 378.312958
last_seq = 16103
current_ts = 378.329346
current_received_ts = 378.329193
current_seq = 16104
count = 162
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.329346
last_received_ts = 378.329193
last_seq = 16104
current_ts = 378.346008
current_received_ts = 378.345581
current_seq = 16105
count = 163
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.346008
last_received_ts = 378.345581
last_seq = 16105
current_ts = 378.362701
current_received_ts = 378.362549
current_seq = 16106
count = 164
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.362701
last_received_ts = 378.362549
last_seq = 16106
current_ts = 378.379364
current_received_ts = 378.378876
current_seq = 16107
count = 165
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.379364
last_received_ts = 378.378876
last_seq = 16107
current_ts = 378.396027
current_received_ts = 378.395599
current_seq = 16108
count = 166
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.396027
last_received_ts = 378.395599
last_seq = 16108
current_ts = 378.412689
current_received_ts = 378.412872
current_seq = 16109
count = 167
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.412689
last_received_ts = 378.412872
last_seq = 16109
current_ts = 378.429352
current_received_ts = 378.429230
current_seq = 16110
count = 168
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.429352
last_received_ts = 378.429230
last_seq = 16110
current_ts = 378.446014
current_received_ts = 378.445557
current_seq = 16111
count = 169
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.446014
last_received_ts = 378.445557
last_seq = 16111
current_ts = 378.462677
current_received_ts = 378.462921
current_seq = 16112
count = 170
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.462677
last_received_ts = 378.462921
last_seq = 16112
current_ts = 378.479370
current_received_ts = 378.479187
current_seq = 16113
count = 171
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.479370
last_received_ts = 378.479187
last_seq = 16113
current_ts = 378.496033
current_received_ts = 378.495575
current_seq = 16114
count = 172
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.496033
last_received_ts = 378.495575
last_seq = 16114
current_ts = 378.512695
current_received_ts = 378.512817
current_seq = 16115
count = 173
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.512695
last_received_ts = 378.512817
last_seq = 16115
current_ts = 378.529358
current_received_ts = 378.528931
current_seq = 16116
count = 174
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.529358
last_received_ts = 378.528931
last_seq = 16116
current_ts = 378.546021
current_received_ts = 378.545776
current_seq = 16117
count = 175
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.546021
last_received_ts = 378.545776
last_seq = 16117
current_ts = 378.562683
current_received_ts = 378.562500
current_seq = 16118
count = 176
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.562683
last_received_ts = 378.562500
last_seq = 16118
current_ts = 378.579346
current_received_ts = 378.579224
current_seq = 16119
count = 177
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.579346
last_received_ts = 378.579224
last_seq = 16119
current_ts = 378.596039
current_received_ts = 378.595520
current_seq = 16120
count = 178
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.596039
last_received_ts = 378.595520
last_seq = 16120
current_ts = 378.612701
current_received_ts = 378.612671
current_seq = 16121
count = 179
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.612701
last_received_ts = 378.612671
last_seq = 16121
current_ts = 378.629364
current_received_ts = 378.629181
current_seq = 16122
count = 180
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.629364
last_received_ts = 378.629181
last_seq = 16122
current_ts = 378.646027
current_received_ts = 378.645844
current_seq = 16123
count = 181
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.646027
last_received_ts = 378.645844
last_seq = 16123
current_ts = 378.662689
current_received_ts = 378.662567
current_seq = 16124
count = 182
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.662689
last_received_ts = 378.662567
last_seq = 16124
current_ts = 378.679352
current_received_ts = 378.678864
current_seq = 16125
count = 183
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.679352
last_received_ts = 378.678864
last_seq = 16125
current_ts = 378.696014
current_received_ts = 378.695709
current_seq = 16126
count = 184
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.696014
last_received_ts = 378.695709
last_seq = 16126
current_ts = 378.712708
current_received_ts = 378.712524
current_seq = 16127
count = 185
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 15us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.712708
last_received_ts = 378.712524
last_seq = 16127
current_ts = 378.729370
current_received_ts = 378.729187
current_seq = 16128
count = 186
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.729370
last_received_ts = 378.729187
last_seq = 16128
current_ts = 378.746033
current_received_ts = 378.745667
current_seq = 16129
count = 187
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.746033
last_received_ts = 378.745667
last_seq = 16129
current_ts = 378.762695
current_received_ts = 378.762695
current_seq = 16130
count = 188
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.762695
last_received_ts = 378.762695
last_seq = 16130
current_ts = 378.779358
current_received_ts = 378.779205
current_seq = 16131
count = 189
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.779358
last_received_ts = 378.779205
last_seq = 16131
current_ts = 378.796021
current_received_ts = 378.795532
current_seq = 16132
count = 190
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.796021
last_received_ts = 378.795532
last_seq = 16132
current_ts = 378.812683
current_received_ts = 378.812378
current_seq = 16133
count = 191
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.812683
last_received_ts = 378.812378
last_seq = 16133
current_ts = 378.829376
current_received_ts = 378.829254
current_seq = 16134
count = 192
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.829376
last_received_ts = 378.829254
last_seq = 16134
current_ts = 378.846039
current_received_ts = 378.845551
current_seq = 16135
count = 193
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.846039
last_received_ts = 378.845551
last_seq = 16135
current_ts = 378.862701
current_received_ts = 378.862640
current_seq = 16136
count = 194
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 19us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.862701
last_received_ts = 378.862640
last_seq = 16136
current_ts = 378.879364
current_received_ts = 378.879181
current_seq = 16137
count = 195
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.879364
last_received_ts = 378.879181
last_seq = 16137
current_ts = 378.896027
current_received_ts = 378.895538
current_seq = 16138
count = 196
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.896027
last_received_ts = 378.895538
last_seq = 16138
current_ts = 378.912689
current_received_ts = 378.912506
current_seq = 16139
count = 197
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 18us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.912689
last_received_ts = 378.912506
last_seq = 16139
current_ts = 378.929382
current_received_ts = 378.929199
current_seq = 16140
count = 198
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.929382
last_received_ts = 378.929199
last_seq = 16140
current_ts = 378.946014
current_received_ts = 378.945557
current_seq = 16141
count = 199
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.946014
last_received_ts = 378.945557
last_seq = 16141
current_ts = 378.962708
current_received_ts = 378.962250
current_seq = 16142
count = 200
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.962708
last_received_ts = 378.962250
last_seq = 16142
current_ts = 378.979370
current_received_ts = 378.979218
current_seq = 16143
count = 201
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.979370
last_received_ts = 378.979218
last_seq = 16143
current_ts = 378.996033
current_received_ts = 378.995575
current_seq = 16144
count = 202
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 378.996033
last_received_ts = 378.995575
last_seq = 16144
current_ts = 379.012695
current_received_ts = 379.012543
current_seq = 16145
count = 203
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.012695
last_received_ts = 379.012543
last_seq = 16145
current_ts = 379.029358
current_received_ts = 379.029236
current_seq = 16146
count = 204
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.029358
last_received_ts = 379.029236
last_seq = 16146
current_ts = 379.046021
current_received_ts = 379.046082
current_seq = 16147
count = 205
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 19us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.046021
last_received_ts = 379.046082
last_seq = 16147
current_ts = 379.062714
current_received_ts = 379.062927
current_seq = 16148
count = 206
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 19us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.062714
last_received_ts = 379.062927
last_seq = 16148
current_ts = 379.079376
current_received_ts = 379.078949
current_seq = 16149
count = 207
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.079376
last_received_ts = 379.078949
last_seq = 16149
current_ts = 379.096039
current_received_ts = 379.095551
current_seq = 16150
count = 208
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.096039
last_received_ts = 379.095551
last_seq = 16150
current_ts = 379.112701
current_received_ts = 379.112518
current_seq = 16151
count = 209
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 18us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.112701
last_received_ts = 379.112518
last_seq = 16151
current_ts = 379.129364
current_received_ts = 379.128845
current_seq = 16152
count = 210
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.129364
last_received_ts = 379.128845
last_seq = 16152
current_ts = 379.146027
current_received_ts = 379.145569
current_seq = 16153
count = 211
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.146027
last_received_ts = 379.145569
last_seq = 16153
current_ts = 379.162689
current_received_ts = 379.162445
current_seq = 16154
count = 212
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 24us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.162689
last_received_ts = 379.162445
last_seq = 16154
current_ts = 379.179352
current_received_ts = 379.178864
current_seq = 16155
count = 213
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.179352
last_received_ts = 379.178864
last_seq = 16155
current_ts = 379.196045
current_received_ts = 379.195618
current_seq = 16156
count = 214
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.196045
last_received_ts = 379.195618
last_seq = 16156
current_ts = 379.212708
current_received_ts = 379.212463
current_seq = 16157
count = 215
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.212708
last_received_ts = 379.212463
last_seq = 16157
current_ts = 379.229370
current_received_ts = 379.229218
current_seq = 16158
count = 216
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.229370
last_received_ts = 379.229218
last_seq = 16158
current_ts = 379.246033
current_received_ts = 379.245575
current_seq = 16159
count = 217
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.246033
last_received_ts = 379.245575
last_seq = 16159
current_ts = 379.262695
current_received_ts = 379.262512
current_seq = 16160
count = 218
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.262695
last_received_ts = 379.262512
last_seq = 16160
current_ts = 379.279358
current_received_ts = 379.279327
current_seq = 16161
count = 219
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.279358
last_received_ts = 379.279327
last_seq = 16161
current_ts = 379.296021
current_received_ts = 379.295563
current_seq = 16162
count = 220
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.296021
last_received_ts = 379.295563
last_seq = 16162
current_ts = 379.312714
current_received_ts = 379.312347
current_seq = 16163
count = 221
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.312714
last_received_ts = 379.312347
last_seq = 16163
current_ts = 379.329376
current_received_ts = 379.329285
current_seq = 16164
count = 222
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.329376
last_received_ts = 379.329285
last_seq = 16164
current_ts = 379.346039
current_received_ts = 379.345520
current_seq = 16165
count = 223
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.346039
last_received_ts = 379.345520
last_seq = 16165
current_ts = 379.362701
current_received_ts = 379.362671
current_seq = 16166
count = 224
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.362701
last_received_ts = 379.362671
last_seq = 16166
current_ts = 379.379364
current_received_ts = 379.379181
current_seq = 16167
count = 225
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.379364
last_received_ts = 379.379181
last_seq = 16167
current_ts = 379.396027
current_received_ts = 379.395538
current_seq = 16168
count = 226
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.396027
last_received_ts = 379.395538
last_seq = 16168
current_ts = 379.412689
current_received_ts = 379.412689
current_seq = 16169
count = 227
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.412689
last_received_ts = 379.412689
last_seq = 16169
current_ts = 379.429352
current_received_ts = 379.429199
current_seq = 16170
count = 228
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.429352
last_received_ts = 379.429199
last_seq = 16170
current_ts = 379.446045
current_received_ts = 379.445526
current_seq = 16171
count = 229
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.446045
last_received_ts = 379.445526
last_seq = 16171
current_ts = 379.462708
current_received_ts = 379.462952
current_seq = 16172
count = 230
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.462708
last_received_ts = 379.462952
last_seq = 16172
current_ts = 379.479370
current_received_ts = 379.479187
current_seq = 16173
count = 231
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.479370
last_received_ts = 379.479187
last_seq = 16173
current_ts = 379.496033
current_received_ts = 379.495575
current_seq = 16174
count = 232
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.496033
last_received_ts = 379.495575
last_seq = 16174
current_ts = 379.512695
current_received_ts = 379.512146
current_seq = 16175
count = 233
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 17us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.512695
last_received_ts = 379.512146
last_seq = 16175
current_ts = 379.529358
current_received_ts = 379.529602
current_seq = 16176
count = 234
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.529358
last_received_ts = 379.529602
last_seq = 16176
current_ts = 379.546021
current_received_ts = 379.545593
current_seq = 16177
count = 235
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.546021
last_received_ts = 379.545593
last_seq = 16177
current_ts = 379.562683
current_received_ts = 379.562500
current_seq = 16178
count = 236
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.562683
last_received_ts = 379.562500
last_seq = 16178
current_ts = 379.579376
current_received_ts = 379.579193
current_seq = 16179
count = 237
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.579376
last_received_ts = 379.579193
last_seq = 16179
current_ts = 379.596039
current_received_ts = 379.595551
current_seq = 16180
count = 238
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.596039
last_received_ts = 379.595551
last_seq = 16180
current_ts = 379.612701
current_received_ts = 379.612671
current_seq = 16181
count = 239
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.612701
last_received_ts = 379.612671
last_seq = 16181
current_ts = 379.629364
current_received_ts = 379.629211
current_seq = 16182
count = 240
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.629364
last_received_ts = 379.629211
last_seq = 16182
current_ts = 379.646027
current_received_ts = 379.645538
current_seq = 16183
count = 241
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.646027
last_received_ts = 379.645538
last_seq = 16183
current_ts = 379.662720
current_received_ts = 379.662720
current_seq = 16184
count = 242
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.662720
last_received_ts = 379.662720
last_seq = 16184
current_ts = 379.679352
current_received_ts = 379.679199
current_seq = 16185
count = 243
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.679352
last_received_ts = 379.679199
last_seq = 16185
current_ts = 379.696045
current_received_ts = 379.695557
current_seq = 16186
count = 244
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.696045
last_received_ts = 379.695557
last_seq = 16186
current_ts = 379.712708
current_received_ts = 379.712891
current_seq = 16187
count = 245
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 17us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.712708
last_received_ts = 379.712891
last_seq = 16187
current_ts = 379.729370
current_received_ts = 379.729187
current_seq = 16188
count = 246
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.729370
last_received_ts = 379.729187
last_seq = 16188
current_ts = 379.746033
current_received_ts = 379.745575
current_seq = 16189
count = 247
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.746033
last_received_ts = 379.745575
last_seq = 16189
current_ts = 379.762695
current_received_ts = 379.762512
current_seq = 16190
count = 248
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.762695
last_received_ts = 379.762512
last_seq = 16190
current_ts = 379.779388
current_received_ts = 379.779327
current_seq = 16191
count = 249
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.779388
last_received_ts = 379.779327
last_seq = 16191
current_ts = 379.796021
current_received_ts = 379.795593
current_seq = 16192
count = 250
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.796021
last_received_ts = 379.795593
last_seq = 16192
current_ts = 379.812714
current_received_ts = 379.812469
current_seq = 16193
count = 251
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.812714
last_received_ts = 379.812469
last_seq = 16193
current_ts = 379.829376
current_received_ts = 379.829224
current_seq = 16194
count = 252
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.829376
last_received_ts = 379.829224
last_seq = 16194
current_ts = 379.846039
current_received_ts = 379.846100
current_seq = 16195
count = 253
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 44us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.846039
last_received_ts = 379.846100
last_seq = 16195
current_ts = 379.862701
current_received_ts = 379.862885
current_seq = 16196
count = 254
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 21us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.862701
last_received_ts = 379.862885
last_seq = 16196
current_ts = 379.879364
current_received_ts = 379.879181
current_seq = 16197
count = 255
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 23us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.879364
last_received_ts = 379.879181
last_seq = 16197
current_ts = 379.896057
current_received_ts = 379.895569
current_seq = 16198
count = 256
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 22us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.896057
last_received_ts = 379.895569
last_seq = 16198
current_ts = 379.912689
current_received_ts = 379.912140
current_seq = 16199
count = 257
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 17us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.912689
last_received_ts = 379.912140
last_seq = 16199
current_ts = 379.929382
current_received_ts = 379.929352
current_seq = 16200
count = 258
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 20us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.929382
last_received_ts = 379.929352
last_seq = 16200
current_ts = 379.946045
current_received_ts = 379.945679
current_seq = 16201
count = 259
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 12us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.946045
last_received_ts = 379.945679
last_seq = 16201
current_ts = 379.962708
current_received_ts = 379.962585
current_seq = 16202
count = 260
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 13us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.962708
last_received_ts = 379.962585
last_seq = 16202
current_ts = 379.979370
current_received_ts = 379.978821
current_seq = 16203
count = 261
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 13us
(kms_flip:2444) DEBUG: name = flip
last_ts = 379.979370
last_received_ts = 379.978821
last_seq = 16203
current_ts = 379.996033
current_received_ts = 379.995422
current_seq = 16204
count = 262
seq_step = 1
(kms_flip:2444) DEBUG: Vblank took 818us
(kms_flip:2444) CRITICAL: Test assertion failure function run_test_step, file ../tests/kms_flip.c:926:
(kms_flip:2444) CRITICAL: Failed assertion: end - start < 500
(kms_flip:2444) CRITICAL: Last errno: 4, Interrupted system call
(kms_flip:2444) igt_core-INFO: Stack trace:
(kms_flip:2444) igt_core-INFO:   #0 ../lib/igt_core.c:2075 __igt_fail_assert()
(kms_flip:2444) igt_core-INFO:   #1 ../tests/kms_flip.c:921 run_test_on_crtc_set.constprop.0()
(kms_flip:2444) igt_core-INFO:   #2 ../tests/kms_flip.c:1887 run_test()
(kms_flip:2444) igt_core-INFO:   #3 ../tests/kms_flip.c:2156 __igt_unique____real_main2043()
(kms_flip:2444) igt_core-INFO:   #4 ../tests/kms_flip.c:2043 main()
(kms_flip:2444) igt_core-INFO:   #5 [__libc_init_first+0x8a]
(kms_flip:2444) igt_core-INFO:   #6 [__libc_start_main+0x8b]
(kms_flip:2444) igt_core-INFO:   #7 [_start+0x25]
****  END  ****
Dynamic subtest A-HDMI-A1: FAIL (5.238s)
Dmesg
<6> [374.721077] Console: switching to colour dummy device 80x25
<6> [374.722014] [IGT] kms_flip: executing
<7> [374.731254] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [374.732929] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x000001dc [0x000001dc]
<7> [374.734854] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [374.750434] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:165:HDMI-A-1]
<7> [374.750455] i915 0000:00:02.0: [drm:intel_hdmi_detect [i915]] [CONNECTOR:165:HDMI-A-1]
<7> [374.775565] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:165:HDMI-A-1] HDMI: DVI dual 0, max TMDS clock 340000 kHz
<7> [374.775584] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:165:HDMI-A-1] HDMI sink does deep color 30.
<7> [374.775590] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:165:HDMI-A-1] HDMI sink does deep color 36.
<7> [374.775596] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:165:HDMI-A-1] Assigning HDMI sink color depth as 12 bpc.
<7> [374.775602] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:165:HDMI-A-1] HDMI sink does YCRCB444 in deep color.
<7> [374.775608] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:165:HDMI-A-1] HF-VSDB: max TMDS clock: 600000 KHz, HDMI 2.1 support: no, DSC 1.2 support: no
<7> [374.775617] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:165:HDMI-A-1] ELD monitor 28E850
<7> [374.775623] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:165:HDMI-A-1] HDMI: latency present 0 0, video latency 0 0, audio latency 0 0
<7> [374.775631] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:165:HDMI-A-1] ELD size 32, SAD count 1
<7> [374.775847] i915 0000:00:02.0: [drm:do_gmbus_xfer [i915]] GMBUS [i915 gmbus dpb] NAK for addr: 0040 w(1)
<7> [374.776299] i915 0000:00:02.0: [drm:do_gmbus_xfer [i915]] GMBUS [i915 gmbus dpb] NAK on first message, retry
<7> [374.778530] i915 0000:00:02.0: [drm:do_gmbus_xfer [i915]] GMBUS [i915 gmbus dpb] NAK for addr: 0040 w(1)
<7> [374.779128] i915 0000:00:02.0: [drm:drm_dp_dual_mode_detect [drm_display_helper]] DP dual mode HDMI ID: (err -6)
<7> [374.781097] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:165:HDMI-A-1] probed modes:
<7> [374.781111] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1083 1088 1125 0x48 0x9
<7> [374.781119] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 60 594000 4096 4184 4272 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.781127] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 60 593407 4096 4184 4272 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.781134] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 50 594000 4096 5064 5152 5280 2160 2168 2178 2250 0x40 0x5
<7> [374.781140] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 24 297000 4096 5116 5204 5500 2160 2168 2178 2250 0x40 0x5
<7> [374.781146] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 24 296703 4096 5116 5204 5500 2160 2168 2178 2250 0x40 0x5
<7> [374.781153] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 60 594000 3840 4016 4104 4400 2160 2162 2172 2250 0x40 0x5
<7> [374.781159] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 60 594000 3840 4016 4104 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.781165] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 60 593407 3840 4016 4104 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.781172] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 50 594000 3840 4896 4984 5280 2160 2168 2178 2250 0x40 0x5
<7> [374.781178] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 30 297000 3840 3888 3920 4400 2160 2164 2170 2250 0x40 0x9
<7> [374.781184] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 30 297000 3840 4016 4104 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.781190] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 30 296703 3840 4016 4104 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.781197] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 25 297000 3840 4896 4984 5280 2160 2168 2178 2250 0x40 0x5
<7> [374.781203] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 24 297000 3840 5116 5204 5500 2160 2168 2178 2250 0x40 0x5
<7> [374.781209] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 24 296703 3840 5116 5204 5500 2160 2168 2178 2250 0x40 0x5
<7> [374.781215] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2880x1800": 60 336720 2880 2928 2960 3040 1800 1803 1809 1846 0x40 0x9
<7> [374.781221] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2560x1600": 60 268500 2560 2608 2640 2720 1600 1603 1609 1646 0x40 0x9
<7> [374.781228] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2560x1440": 60 241500 2560 2608 2640 2720 1440 1443 1449 1481 0x40 0x9
<7> [374.781234] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1200": 60 154000 1920 1968 2000 2080 1200 1203 1209 1235 0x40 0x9
<7> [374.781240] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 120 297000 1920 2008 2052 2200 1080 1084 1089 1125 0x40 0x5
<7> [374.781246] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 120 296703 1920 2008 2052 2200 1080 1084 1089 1125 0x40 0x5
<7> [374.781253] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 75 220597 1920 2056 2264 2608 1080 1081 1084 1128 0x0 0x6
<7> [374.781259] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080i": 60 74250 1920 2008 2052 2200 1080 1084 1094 1125 0x40 0x15
<7> [374.781266] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080i": 60 74176 1920 2008 2052 2200 1080 1084 1094 1125 0x40 0x15
<7> [374.781272] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 50 148500 1920 2448 2492 2640 1080 1084 1089 1125 0x40 0x5
<7> [374.781278] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080i": 50 74250 1920 2448 2492 2640 1080 1084 1094 1125 0x40 0x15
<7> [374.781285] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 24 74250 1920 2558 2602 2750 1080 1084 1089 1125 0x40 0x5
<7> [374.781291] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 24 74176 1920 2558 2602 2750 1080 1084 1089 1125 0x40 0x5
<7> [374.781297] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1680x1050": 60 119000 1680 1728 1760 1840 1050 1053 1059 1080 0x40 0x9
<7> [374.781304] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1600x900": 60 108000 1600 1624 1704 1800 900 901 904 1000 0x40 0x5
<7> [374.781310] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x1024": 75 135000 1280 1296 1440 1688 1024 1025 1028 1066 0x40 0x5
<7> [374.781316] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x1024": 61 110809 1280 1360 1496 1712 1024 1025 1028 1061 0x0 0x6
<7> [374.781322] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1440x900": 60 88750 1440 1488 1520 1600 900 903 909 926 0x40 0x9
<7> [374.781329] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x800": 60 71000 1280 1328 1360 1440 800 803 809 823 0x40 0x9
<7> [374.781335] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 60 74250 1280 1390 1430 1650 720 725 730 750 0x40 0x5
<7> [374.781342] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 60 74250 1280 1390 1430 1650 720 725 730 750 0x40 0x5
<7> [374.781348] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 60 74176 1280 1390 1430 1650 720 725 730 750 0x40 0x5
<7> [374.781354] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 50 74250 1280 1720 1760 1980 720 725 730 750 0x40 0x5
<7> [374.781360] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1024x768": 75 78750 1024 1040 1136 1312 768 769 772 800 0x40 0x5
<7> [374.781367] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1024x768": 70 75000 1024 1048 1184 1328 768 771 777 806 0x40 0xa
<7> [374.781373] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1024x768": 60 65000 1024 1048 1184 1344 768 771 777 806 0x40 0xa
<7> [374.781379] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 75 49500 800 816 896 1056 600 601 604 625 0x40 0x5
<7> [374.781385] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 72 50000 800 856 976 1040 600 637 643 666 0x40 0x5
<7> [374.781392] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 60 40000 800 840 968 1056 600 601 605 628 0x40 0x5
<7> [374.781398] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 56 36000 800 824 896 1024 600 601 603 625 0x40 0x5
<7> [374.781404] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "720x576": 50 27000 720 732 796 864 576 581 586 625 0x40 0xa
<7> [374.781410] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "720x480": 60 27027 720 736 798 858 480 489 495 525 0x40 0xa
<7> [374.781416] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "720x480": 60 27000 720 736 798 858 480 489 495 525 0x40 0xa
<7> [374.781422] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 75 31500 640 656 720 840 480 481 484 500 0x40 0xa
<7> [374.781429] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 73 31500 640 664 704 832 480 489 492 520 0x40 0xa
<7> [374.781435] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 60 25200 640 656 752 800 480 490 492 525 0x40 0xa
<7> [374.781441] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 60 25175 640 656 752 800 480 490 492 525 0x40 0xa
<7> [374.781447] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 60 25175 640 656 752 800 480 490 492 525 0x40 0xa
<7> [374.781853] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:175:HDMI-A-2]
<7> [374.781868] i915 0000:00:02.0: [drm:intel_hdmi_detect [i915]] [CONNECTOR:175:HDMI-A-2]
<7> [374.808600] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:175:HDMI-A-2] HDMI: DVI dual 0, max TMDS clock 340000 kHz
<7> [374.808619] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:175:HDMI-A-2] HDMI sink does deep color 30.
<7> [374.808625] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:175:HDMI-A-2] HDMI sink does deep color 36.
<7> [374.808631] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:175:HDMI-A-2] Assigning HDMI sink color depth as 12 bpc.
<7> [374.808638] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:175:HDMI-A-2] HDMI sink does YCRCB444 in deep color.
<7> [374.808644] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:175:HDMI-A-2] HF-VSDB: max TMDS clock: 600000 KHz, HDMI 2.1 support: no, DSC 1.2 support: no
<7> [374.808653] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:175:HDMI-A-2] ELD monitor 28E850
<7> [374.808661] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:175:HDMI-A-2] HDMI: latency present 0 0, video latency 0 0, audio latency 0 0
<7> [374.808668] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:175:HDMI-A-2] ELD size 32, SAD count 1
<7> [374.808887] i915 0000:00:02.0: [drm:do_gmbus_xfer [i915]] GMBUS [i915 gmbus dpc] NAK for addr: 0040 w(1)
<7> [374.809348] i915 0000:00:02.0: [drm:do_gmbus_xfer [i915]] GMBUS [i915 gmbus dpc] NAK on first message, retry
<7> [374.811680] i915 0000:00:02.0: [drm:do_gmbus_xfer [i915]] GMBUS [i915 gmbus dpc] NAK for addr: 0040 w(1)
<7> [374.812291] i915 0000:00:02.0: [drm:drm_dp_dual_mode_detect [drm_display_helper]] DP dual mode HDMI ID: (err -6)
<7> [374.814200] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:175:HDMI-A-2] probed modes:
<7> [374.814214] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1083 1088 1125 0x48 0x9
<7> [374.814222] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 60 594000 4096 4184 4272 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.814229] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 60 593407 4096 4184 4272 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.814236] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 50 594000 4096 5064 5152 5280 2160 2168 2178 2250 0x40 0x5
<7> [374.814243] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 24 297000 4096 5116 5204 5500 2160 2168 2178 2250 0x40 0x5
<7> [374.814249] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4096x2160": 24 296703 4096 5116 5204 5500 2160 2168 2178 2250 0x40 0x5
<7> [374.814255] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 60 594000 3840 4016 4104 4400 2160 2162 2172 2250 0x40 0x5
<7> [374.814262] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 60 594000 3840 4016 4104 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.814268] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 60 593407 3840 4016 4104 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.814274] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 50 594000 3840 4896 4984 5280 2160 2168 2178 2250 0x40 0x5
<7> [374.814280] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 30 297000 3840 3888 3920 4400 2160 2164 2170 2250 0x40 0x9
<7> [374.814286] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 30 297000 3840 4016 4104 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.814293] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 30 296703 3840 4016 4104 4400 2160 2168 2178 2250 0x40 0x5
<7> [374.814299] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 25 297000 3840 4896 4984 5280 2160 2168 2178 2250 0x40 0x5
<7> [374.814305] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 24 297000 3840 5116 5204 5500 2160 2168 2178 2250 0x40 0x5
<7> [374.814311] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 24 296703 3840 5116 5204 5500 2160 2168 2178 2250 0x40 0x5
<7> [374.814317] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2880x1800": 60 336720 2880 2928 2960 3040 1800 1803 1809 1846 0x40 0x9
<7> [374.814324] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2560x1600": 60 268500 2560 2608 2640 2720 1600 1603 1609 1646 0x40 0x9
<7> [374.814330] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2560x1440": 60 241500 2560 2608 2640 2720 1440 1443 1449 1481 0x40 0x9
<7> [374.814336] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1200": 60 154000 1920 1968 2000 2080 1200 1203 1209 1235 0x40 0x9
<7> [374.814342] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 120 297000 1920 2008 2052 2200 1080 1084 1089 1125 0x40 0x5
<7> [374.814348] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 120 296703 1920 2008 2052 2200 1080 1084 1089 1125 0x40 0x5
<7> [374.814355] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 75 220597 1920 2056 2264 2608 1080 1081 1084 1128 0x0 0x6
<7> [374.814361] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080i": 60 74250 1920 2008 2052 2200 1080 1084 1094 1125 0x40 0x15
<7> [374.814367] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080i": 60 74176 1920 2008 2052 2200 1080 1084 1094 1125 0x40 0x15
<7> [374.814374] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 50 148500 1920 2448 2492 2640 1080 1084 1089 1125 0x40 0x5
<7> [374.814380] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080i": 50 74250 1920 2448 2492 2640 1080 1084 1094 1125 0x40 0x15
<7> [374.814386] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 24 74250 1920 2558 2602 2750 1080 1084 1089 1125 0x40 0x5
<7> [374.814392] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 24 74176 1920 2558 2602 2750 1080 1084 1089 1125 0x40 0x5
<7> [374.814399] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1680x1050": 60 119000 1680 1728 1760 1840 1050 1053 1059 1080 0x40 0x9
<7> [374.814405] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1600x900": 60 108000 1600 1624 1704 1800 900 901 904 1000 0x40 0x5
<7> [374.814411] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x1024": 75 135000 1280 1296 1440 1688 1024 1025 1028 1066 0x40 0x5
<7> [374.814417] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x1024": 61 110809 1280 1360 1496 1712 1024 1025 1028 1061 0x0 0x6
<7> [374.814423] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1440x900": 60 88750 1440 1488 1520 1600 900 903 909 926 0x40 0x9
<7> [374.814430] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x800": 60 71000 1280 1328 1360 1440 800 803 809 823 0x40 0x9
<7> [374.814436] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 60 74250 1280 1390 1430 1650 720 725 730 750 0x40 0x5
<7> [374.814442] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 60 74250 1280 1390 1430 1650 720 725 730 750 0x40 0x5
<7> [374.814449] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 60 74176 1280 1390 1430 1650 720 725 730 750 0x40 0x5
<7> [374.814455] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 50 74250 1280 1720 1760 1980 720 725 730 750 0x40 0x5
<7> [374.814461] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1024x768": 75 78750 1024 1040 1136 1312 768 769 772 800 0x40 0x5
<7> [374.814720] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1024x768": 70 75000 1024 1048 1184 1328 768 771 777 806 0x40 0xa
<7> [374.814729] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1024x768": 60 65000 1024 1048 1184 1344 768 771 777 806 0x40 0xa
<7> [374.814735] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 75 49500 800 816 896 1056 600 601 604 625 0x40 0x5
<7> [374.814763] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 72 50000 800 856 976 1040 600 637 643 666 0x40 0x5
<7> [374.814770] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 60 40000 800 840 968 1056 600 601 605 628 0x40 0x5
<7> [374.814777] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 56 36000 800 824 896 1024 600 601 603 625 0x40 0x5
<7> [374.814783] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "720x576": 50 27000 720 732 796 864 576 581 586 625 0x40 0xa
<7> [374.814789] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "720x480": 60 27027 720 736 798 858 480 489 495 525 0x40 0xa
<7> [374.814796] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "720x480": 60 27000 720 736 798 858 480 489 495 525 0x40 0xa
<7> [374.814802] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 75 31500 640 656 720 840 480 481 484 500 0x40 0xa
<7> [374.814808] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 73 31500 640 664 704 832 480 489 492 520 0x40 0xa
<7> [374.814814] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 60 25200 640 656 752 800 480 490 492 525 0x40 0xa
<7> [374.814821] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 60 25175 640 656 752 800 480 490 492 525 0x40 0xa
<7> [374.814827] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 60 25175 640 656 752 800 480 490 492 525 0x40 0xa
<6> [374.832970] [IGT] kms_flip: starting subtest flip-vs-expired-vblank-interruptible
<6> [374.838768] [IGT] kms_flip: starting dynamic subtest A-HDMI-A1
<7> [374.841110] i915 0000:00:02.0: [drm:drm_mode_addfb2] [FB:181]
<7> [374.841447] i915 0000:00:02.0: [drm:drm_mode_addfb2] [FB:182]
<7> [374.903779] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:77:pipe A]
<7> [374.904006] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.enable (expected yes, found no)
<7> [374.904613] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.active (expected yes, found no)
<7> [374.905017] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in cpu_transcoder (expected 0, found -1)
<7> [374.905394] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in lane_count (expected 4, found 0)
<7> [374.905954] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in lane_lat_optim_mask (expected 0x0000000d, found 0x00000000)
<7> [374.906334] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in output_types (expected 0x00000040, found 0x00000000)
<7> [374.906795] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [374.907203] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 1920, found 0)
<7> [374.909122] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 2200, found 0)
<7> [374.909832] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 1920, found 0)
<7> [374.910213] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 2200, found 0)
<7> [374.910695] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2008, found 0)
<7> [374.911125] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2052, found 0)
<7> [374.911588] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1080, found 0)
<7> [374.911967] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1080, found 0)
<7> [374.912341] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1083, found 0)
<7> [374.912887] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1088, found 0)
<7> [374.913287] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1125, found 0)
<7> [374.913797] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1125, found 0)
<7> [374.914175] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 1920, found 0)
<7> [374.914631] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 2200, found 0)
<7> [374.915037] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 1920, found 0)
<7> [374.915414] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 2200, found 0)
<7> [374.916764] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2008, found 0)
<7> [374.917235] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2052, found 0)
<7> [374.917735] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1080, found 0)
<7> [374.918116] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1080, found 0)
<7> [374.918574] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1083, found 0)
<7> [374.918953] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1088, found 0)
<7> [374.919328] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1125, found 0)
<7> [374.919980] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1125, found 0)
<7> [374.920421] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [374.920887] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 1, found 0)
<7> [374.921266] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 8, found 0)
<7> [374.921803] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in has_hdmi_sink (expected yes, found no)
<7> [374.922184] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in has_infoframe (expected yes, found no)
<7> [374.922657] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in pipe_bpp (expected 36, found 0)
<7> [374.923063] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 148500, found 0)
<7> [374.923438] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 148500, found 0)
<7> [374.923903] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in port_clock (expected 222750, found 0)
<7> [374.924290] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in infoframes.enable (expected 0x00000071, found 0x00000000)
<7> [374.924838] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in infoframes.gcp (expected 0x00000006, found 0x00000000)
<7> [374.925218] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in avi infoframe
<7> [374.925726] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] expected:
<7> [374.926106] i915 0000:00:02.0: HDMI infoframe: Auxiliary Video Information (AVI), version 2, length 13
<7> [374.926110] i915 0000:00:02.0: colorspace: RGB
<7> [374.926114] i915 0000:00:02.0: scan mode: Underscan
<7> [374.926117] i915 0000:00:02.0: colorimetry: No Data
<7> [374.926121] i915 0000:00:02.0: picture aspect: No Data
<7> [374.926124] i915 0000:00:02.0: active aspect: Same as Picture
<7> [374.926128] i915 0000:00:02.0: itc: No Data
<7> [374.926131] i915 0000:00:02.0: extended colorimetry: xvYCC 601
<7> [374.926134] i915 0000:00:02.0: quantization range: Full
<7> [374.926137] i915 0000:00:02.0: nups: Unknown Non-uniform Scaling
<7> [374.926141] i915 0000:00:02.0: video code: 0
<7> [374.926144] i915 0000:00:02.0: ycc quantization range: Full
<7> [374.926147] i915 0000:00:02.0: hdmi content type: Graphics
<7> [374.926150] i915 0000:00:02.0: pixel repeat: 0
<7> [374.926153] i915 0000:00:02.0: bar top 0, bottom 0, left 0, right 0
<7> [374.926157] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] found:
<7> [374.926649] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in spd infoframe
<7> [374.927100] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] expected:
<7> [374.927646] i915 0000:00:02.0: HDMI infoframe: Source Product Description (SPD), version 1, length 25
<7> [374.927651] i915 0000:00:02.0: vendor: Intel
<7> [374.927655] i915 0000:00:02.0: product: Integrated gfx
<7> [374.927658] i915 0000:00:02.0: source device information: PC General (0x9)
<7> [374.927662] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] found:
<7> [374.928097] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hdmi infoframe
<7> [374.928580] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] expected:
<7> [374.928960] i915 0000:00:02.0: HDMI infoframe: Vendor, version 1, length 4
<7> [374.928965] i915 0000:00:02.0: empty frame
<7> [374.928968] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] found:
<7> [374.929366] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:77:pipe A] fastset requirement not met, forcing full modeset
<7> [374.929868] i915 0000:00:02.0: [drm:intel_dpll_crtc_put [i915]] [CRTC:77:pipe A] releasing PORT PLL B
<7> [374.930336] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:77:pipe A] dbuf slices 0x1 -> 0x0, ddb (0 - 510) -> (0 - 0), active pipes 0x3 -> 0x2
<7> [374.930853] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:120:pipe B] dbuf slices 0x1 -> 0x1, ddb (510 - 1020) -> (0 - 1020), active pipes 0x3 -> 0x2
<7> [374.931304] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [PLANE:35:plane 1A] ddb ( 0 - 497) -> ( 0 - 0), size 497 -> 0
<7> [374.931790] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [PLANE:71:cursor A] ddb ( 497 - 510) -> ( 0 - 0), size 13 -> 0
<7> [374.932190] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:35:plane 1A] level *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm -> wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm
<7> [374.932641] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:35:plane 1A] lines 1, 1, 1, 2, 2, 2, 2, 2, 0, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [374.933015] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:35:plane 1A] blocks 16, 16, 16, 33, 33, 33, 33, 33, 30, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [374.933384] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:35:plane 1A] min_ddb 17, 17, 17, 34, 34, 34, 34, 34, 31, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [374.933918] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [PLANE:78:plane 1B] ddb ( 510 - 1007) -> ( 0 - 988), size 497 -> 988
<7> [374.934296] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [PLANE:114:cursor B] ddb (1007 - 1020) -> ( 988 - 1020), size 13 -> 32
<7> [374.934838] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:77:pipe A] min cdclk: 192000 kHz -> 0 kHz
<7> [374.935254] i915 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [i915]] dbuf bandwidth min cdclk: 18563 kHz -> 9282 kHz
<7> [374.935723] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:77:pipe A] enable: no [modeset]
<7> [374.936101] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:35:plane 1A] fb: [NOFB], visible: no
<7> [374.936575] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:44:plane 2A] fb: [NOFB], visible: no
<7> [374.936955] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:53:plane 3A] fb: [NOFB], visible: no
<7> [374.937329] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:62:plane 4A] fb: [NOFB], visible: no
<7> [374.937946] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:71:cursor A] fb: [NOFB], visible: no
<7> [374.938602] i915 0000:00:02.0: [drm:intel_audio_codec_disable [i915]] [CONNECTOR:165:HDMI-A-1][ENCODER:164:DDI B/PHY B] Disable audio codec on [CRTC:77:pipe A]
<7> [374.960187] i915 0000:00:02.0: [drm:intel_audio_component_get_eld [i915]] Not valid for port B
<7> [374.976960] i915 0000:00:02.0: [drm:intel_disable_transcoder [i915]] disabling pipe A
<7> [374.993554] i915 0000:00:02.0: [drm:intel_ddi_disable_transcoder_func [i915]] Quirk Increase DDI disabled time
<7> [375.096558] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DDI_IO_B
<7> [375.097098] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disable PORT PLL B (active 0x1, on? 1) for [CRTC:77:pipe A]
<7> [375.098878] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disabling PORT PLL B
<7> [375.099373] i915 0000:00:02.0: [drm:__intel_fbc_disable [i915]] Disabling FBC on [PLANE:35:plane 1A]
<7> [375.100002] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:164:DDI B/PHY B]
<7> [375.100571] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:174:DDI C/PHY C]
<7> [375.100951] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:165:HDMI-A-1]
<7> [375.112899] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling dpio-common-b
<7> [375.114693] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:77:pipe A]
<7> [375.116440] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:120:pipe B]
<7> [375.116719] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.enable (expected yes, found no)
<7> [375.117155] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.active (expected yes, found no)
<7> [375.117713] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in cpu_transcoder (expected 1, found -1)
<7> [375.118115] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in lane_count (expected 4, found 0)
<7> [375.118638] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in lane_lat_optim_mask (expected 0x0000000d, found 0x00000000)
<7> [375.119018] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in output_types (expected 0x00000040, found 0x00000000)
<7> [375.119393] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [375.120897] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 1920, found 0)
<7> [375.121371] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 2200, found 0)
<7> [375.122488] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 1920, found 0)
<7> [375.122869] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 2200, found 0)
<7> [375.123244] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2008, found 0)
<7> [375.124253] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2052, found 0)
<7> [375.125137] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1080, found 0)
<7> [375.125742] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1080, found 0)
<7> [375.126132] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1083, found 0)
<7> [375.126634] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1088, found 0)
<7> [375.127031] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1125, found 0)
<7> [375.127406] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1125, found 0)
<7> [375.127831] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 1920, found 0)
<7> [375.128227] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 2200, found 0)
<7> [375.128707] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 1920, found 0)
<7> [375.129087] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 2200, found 0)
<7> [375.129481] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2008, found 0)
<7> [375.129887] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2052, found 0)
<7> [375.130262] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1080, found 0)
<7> [375.132583] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1080, found 0)
<7> [375.133098] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1083, found 0)
<7> [375.133551] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1088, found 0)
<7> [375.133930] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1125, found 0)
<7> [375.134305] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1125, found 0)
<7> [375.134909] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [375.135362] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 1, found 0)
<7> [375.135911] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 8, found 0)
<7> [375.136291] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in has_hdmi_sink (expected yes, found no)
<7> [375.136694] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in has_infoframe (expected yes, found no)
<7> [375.137089] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in pipe_bpp (expected 36, found 0)
<7> [375.137513] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 148500, found 0)
<7> [375.137910] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 148500, found 0)
<7> [375.138305] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in port_clock (expected 222750, found 0)
<7> [375.138747] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in infoframes.enable (expected 0x00000071, found 0x00000000)
<7> [375.139128] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in infoframes.gcp (expected 0x00000006, found 0x00000000)
<7> [375.139527] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in avi infoframe
<7> [375.139930] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] expected:
<7> [375.140303] i915 0000:00:02.0: HDMI infoframe: Auxiliary Video Information (AVI), version 2, length 13
<7> [375.140307] i915 0000:00:02.0: colorspace: RGB
<7> [375.140311] i915 0000:00:02.0: scan mode: Underscan
<7> [375.140314] i915 0000:00:02.0: colorimetry: No Data
<7> [375.140318] i915 0000:00:02.0: picture aspect: No Data
<7> [375.140321] i915 0000:00:02.0: active aspect: Same as Picture
<7> [375.140324] i915 0000:00:02.0: itc: No Data
<7> [375.140327] i915 0000:00:02.0: extended colorimetry: xvYCC 601
<7> [375.140331] i915 0000:00:02.0: quantization range: Full
<7> [375.140334] i915 0000:00:02.0: nups: Unknown Non-uniform Scaling
<7> [375.140337] i915 0000:00:02.0: video code: 0
<7> [375.140341] i915 0000:00:02.0: ycc quantization range: Full
<7> [375.140344] i915 0000:00:02.0: hdmi content type: Graphics
<7> [375.140347] i915 0000:00:02.0: pixel repeat: 0
<7> [375.140350] i915 0000:00:02.0: bar top 0, bottom 0, left 0, right 0
<7> [375.140354] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] found:
<7> [375.142838] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in spd infoframe
<7> [375.143434] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] expected:
<7> [375.144022] i915 0000:00:02.0: HDMI infoframe: Source Product Description (SPD), version 1, length 25
<7> [375.144028] i915 0000:00:02.0: vendor: Intel
<7> [375.144032] i915 0000:00:02.0: product: Integrated gfx
<7> [375.144035] i915 0000:00:02.0: source device information: PC General (0x9)
<7> [375.144039] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] found:
<7> [375.144420] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:120:pipe B] fastset requirement not met in hdmi infoframe
<7> [375.144848] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] expected:
<7> [375.145225] i915 0000:00:02.0: HDMI infoframe: Vendor, version 1, length 4
<7> [375.145230] i915 0000:00:02.0: empty frame
<7> [375.145233] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] found:
<7> [375.145942] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:120:pipe B] fastset requirement not met, forcing full modeset
<7> [375.146417] i915 0000:00:02.0: [drm:intel_dpll_crtc_put [i915]] [CRTC:120:pipe B] releasing PORT PLL C
<7> [375.147048] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:120:pipe B] dbuf slices 0x1 -> 0x0, ddb (0 - 1020) -> (0 - 0), active pipes 0x2 -> 0x0
<7> [375.147520] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [PLANE:78:plane 1B] ddb ( 0 - 988) -> ( 0 - 0), size 988 -> 0
<7> [375.147894] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [PLANE:114:cursor B] ddb ( 988 - 1020) -> ( 0 - 0), size 32 -> 0
<7> [375.148292] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:78:plane 1B] level *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm -> wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm
<7> [375.148712] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:78:plane 1B] lines 1, 1, 1, 2, 2, 2, 2, 2, 0, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [375.149112] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:78:plane 1B] blocks 16, 16, 16, 33, 33, 33, 33, 33, 30, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [375.149567] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:78:plane 1B] min_ddb 17, 17, 17, 34, 34, 34, 34, 34, 31, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [375.150018] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:120:pipe B] min cdclk: 192000 kHz -> 0 kHz
<7> [375.150429] i915 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [i915]] dbuf bandwidth min cdclk: 9282 kHz -> 0 kHz
<7> [375.150913] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] Modeset required for cdclk change
<7> [375.151286] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] New cdclk calculated to be logical 79200 kHz, actual 79200 kHz
<7> [375.154085] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] New voltage level calculated to be logical 4, actual 4
<7> [375.155027] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:120:pipe B] enable: no [modeset]
<7> [375.155629] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:78:plane 1B] fb: [NOFB], visible: no
<7> [375.156007] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:87:plane 2B] fb: [NOFB], visible: no
<7> [375.156391] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:96:plane 3B] fb: [NOFB], visible: no
<7> [375.156897] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:105:plane 4B] fb: [NOFB], visible: no
<7> [375.157296] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:114:cursor B] fb: [NOFB], visible: no
<7> [375.157930] i915 0000:00:02.0: [drm:intel_audio_codec_disable [i915]] [CONNECTOR:175:HDMI-A-2][ENCODER:174:DDI C/PHY C] Disable audio codec on [CRTC:120:pipe B]
<7> [375.179512] i915 0000:00:02.0: [drm:intel_audio_component_get_eld [i915]] Not valid for port C
<7> [375.180126] i915 0000:00:02.0: [drm:intel_disable_transcoder [i915]] disabling pipe B
<7> [375.196530] i915 0000:00:02.0: [drm:intel_ddi_disable_transcoder_func [i915]] Quirk Increase DDI disabled time
<7> [375.304843] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DDI_IO_C
<7> [375.305997] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disable PORT PLL C (active 0x2, on? 1) for [CRTC:120:pipe B]
<7> [375.308691] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disabling PORT PLL C
<7> [375.309260] i915 0000:00:02.0: [drm:intel_set_cdclk [i915]] Pre changing CDCLK to 79200 kHz, VCO 633600 kHz, ref 19200 kHz, bypass 19200 kHz, voltage level 4
<7> [375.309787] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:164:DDI B/PHY B]
<7> [375.310226] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:174:DDI C/PHY C]
<7> [375.310890] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:175:HDMI-A-2]
<7> [375.311703] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling dpio-common-c
<7> [375.312121] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling PW_2
<7> [375.312615] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:120:pipe B]
<7> [375.313646] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:163:pipe C]
<7> [375.314057] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:77:pipe A]
<7> [375.314111] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CONNECTOR:165:HDMI-A-1]
<7> [375.314292] i915 0000:00:02.0: [drm:intel_hdmi_compute_clock [i915]] picking 12 bpc for HDMI output (pipe bpp: 36)
<7> [375.314814] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:77:pipe A] hw max bpp: 36, pipe bpp: 36, dithering: 0
<7> [375.315199] i915 0000:00:02.0: [drm:intel_ddi_compute_config_late [i915]] [ENCODER:164:DDI B/PHY B] [CRTC:77:pipe A]
<7> [375.317440] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.enable (expected no, found yes)
<7> [375.318050] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.active (expected no, found yes)
<7> [375.318429] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in cpu_transcoder (expected -1, found 0)
<7> [375.318849] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in lane_count (expected 0, found 4)
<7> [375.319228] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in lane_lat_optim_mask (expected 0x00000000, found 0x0000000d)
<7> [375.319913] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in output_types (expected 0x00000000, found 0x00000040)
<7> [375.320325] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [375.321044] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 1920)
<7> [375.321539] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 2200)
<7> [375.321918] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 1920)
<7> [375.322293] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 2200)
<7> [375.322806] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2008)
<7> [375.323184] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2052)
<7> [375.323595] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1080)
<7> [375.323988] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1080)
<7> [375.324367] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1083)
<7> [375.324796] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1088)
<7> [375.325196] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1125)
<7> [375.325640] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1125)
<7> [375.326017] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 1920)
<7> [375.326394] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 2200)
<7> [375.326829] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 1920)
<7> [375.327221] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 2200)
<7> [375.329663] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2008)
<7> [375.330241] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2052)
<7> [375.330667] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1080)
<7> [375.331044] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1080)
<7> [375.331418] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1083)
<7> [375.331881] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DC_off
<7> [375.332116] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1088)
<7> [375.332288] i915 0000:00:02.0: [drm:gen9_enable_dc5 [i915]] Enabling DC5
<7> [375.332569] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1125)
<7> [375.332682] i915 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [i915]] Setting DC state from 00 to 01
<7> [375.332945] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1125)
<7> [375.333324] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [375.333804] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 0, found 1)
<7> [375.334180] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.flags (8) (expected 0, found 8)
<7> [375.334618] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in has_hdmi_sink (expected no, found yes)
<7> [375.335013] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in has_infoframe (expected no, found yes)
<7> [375.335390] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in pipe_bpp (expected 0, found 36)
<7> [375.335816] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 148500)
<7> [375.336212] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 148500)
<7> [375.336512] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling always-on
<7> [375.336647] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in port_clock (expected 0, found 222750)
<7> [375.337025] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in infoframes.enable (expected 0x00000000, found 0x00000071)
<7> [375.337400] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in infoframes.gcp (expected 0x00000000, found 0x00000006)
<7> [375.337829] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in avi infoframe
<7> [375.338205] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] expected:
<7> [375.340617] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] found:
<7> [375.341189] i915 0000:00:02.0: HDMI infoframe: Auxiliary Video Information (AVI), version 2, length 13
<7> [375.341195] i915 0000:00:02.0: colorspace: RGB
<7> [375.341198] i915 0000:00:02.0: scan mode: Underscan
<7> [375.341202] i915 0000:00:02.0: colorimetry: No Data
<7> [375.341205] i915 0000:00:02.0: picture aspect: No Data
<7> [375.341209] i915 0000:00:02.0: active aspect: Same as Picture
<7> [375.341212] i915 0000:00:02.0: itc: No Data
<7> [375.341215] i915 0000:00:02.0: extended colorimetry: xvYCC 601
<7> [375.341219] i915 0000:00:02.0: quantization range: Full
<7> [375.341222] i915 0000:00:02.0: nups: Unknown Non-uniform Scaling
<7> [375.341225] i915 0000:00:02.0: video code: 0
<7> [375.341228] i915 0000:00:02.0: ycc quantization range: Full
<7> [375.341232] i915 0000:00:02.0: hdmi content type: Graphics
<7> [375.341235] i915 0000:00:02.0: pixel repeat: 0
<7> [375.341238] i915 0000:00:02.0: bar top 0, bottom 0, left 0, right 0
<7> [375.341243] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in spd infoframe
<7> [375.341915] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] expected:
<7> [375.342376] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] found:
<7> [375.342879] i915 0000:00:02.0: HDMI infoframe: Source Product Description (SPD), version 1, length 25
<7> [375.342884] i915 0000:00:02.0: vendor: Intel
<7> [375.342887] i915 0000:00:02.0: product: Integrated gfx
<7> [375.342891] i915 0000:00:02.0: source device information: PC General (0x9)
<7> [375.342895] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:77:pipe A] fastset requirement not met in hdmi infoframe
<7> [375.343271] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] expected:
<7> [375.343711] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] found:
<7> [375.344102] i915 0000:00:02.0: HDMI infoframe: Vendor, version 1, length 4
<7> [375.344107] i915 0000:00:02.0: empty frame
<7> [375.344113] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:77:pipe A] fastset requirement not met, forcing full modeset
<7> [375.344651] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:77:pipe A] dbuf slices 0x0 -> 0x1, ddb (0 - 0) -> (0 - 1020), active pipes 0x0 -> 0x1
<7> [375.345096] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [PLANE:35:plane 1A] ddb ( 0 - 0) -> ( 0 - 988), size 0 -> 988
<7> [375.345553] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [PLANE:71:cursor A] ddb ( 0 - 0) -> ( 988 - 1020), size 0 -> 32
<7> [375.345925] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:35:plane 1A] level wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm
<7> [375.346296] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:35:plane 1A] lines 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 1, 1, 1, 2, 2, 2, 2, 2, 0, 0, 0
<7> [375.346731] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:35:plane 1A] blocks 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 16, 16, 16, 33, 33, 33, 33, 33, 30, 0, 0
<7> [375.347106] i915 0000:00:02.0: [drm:skl_print_plane_changes [i915]] [PLANE:35:plane 1A] min_ddb 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 17, 17, 17, 34, 34, 34, 34, 34, 31, 0, 0
<7> [375.349889] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:77:pipe A] min cdclk: 0 kHz -> 192000 kHz
<7> [375.350423] i915 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [i915]] dbuf bandwidth min cdclk: 0 kHz -> 9282 kHz
<7> [375.350888] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] Modeset required for cdclk change
<7> [375.351264] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] New cdclk calculated to be logical 316800 kHz, actual 316800 kHz
<7> [375.351898] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] New voltage level calculated to be logical 13, actual 13
<7> [375.352352] i915 0000:00:02.0: [drm:bxt_get_dpll [i915]] [CRTC:77:pipe A] using pre-allocated PORT PLL B
<7> [375.352910] i915 0000:00:02.0: [drm:intel_dpll_crtc_get [i915]] [CRTC:77:pipe A] reserving PORT PLL B
<7> [375.353304] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:77:pipe A] enable: yes [modeset]
<7> [375.353721] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] active: yes, output_types: HDMI (0x40), output format: RGB, sink format: RGB
<7> [375.354120] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] cpu_transcoder: A, pipe bpp: 36, dithering: 0
<7> [375.354551] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] MST master transcoder: <invalid>
<7> [375.354946] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [375.355323] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] joiner: no, pipes: 0x0
<7> [375.355762] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] splitter: disabled, link count 0, overlap 0
<7> [375.356137] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] audio: 1, infoframes: 1, infoframes enabled: 0x71
<7> [375.356541] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] GCP: 0x6
<7> [375.356945] i915 0000:00:02.0: HDMI infoframe: Auxiliary Video Information (AVI), version 2, length 13
<7> [375.356950] i915 0000:00:02.0: colorspace: RGB
<7> [375.356954] i915 0000:00:02.0: scan mode: Underscan
<7> [375.356957] i915 0000:00:02.0: colorimetry: No Data
<7> [375.356961] i915 0000:00:02.0: picture aspect: No Data
<7> [375.356964] i915 0000:00:02.0: active aspect: Same as Picture
<7> [375.356968] i915 0000:00:02.0: itc: No Data
<7> [375.356971] i915 0000:00:02.0: extended colorimetry: xvYCC 601
<7> [375.356975] i915 0000:00:02.0: quantization range: Full
<7> [375.356978] i915 0000:00:02.0: nups: Unknown Non-uniform Scaling
<7> [375.356981] i915 0000:00:02.0: video code: 0
<7> [375.356984] i915 0000:00:02.0: ycc quantization range: Full
<7> [375.356988] i915 0000:00:02.0: hdmi content type: Graphics
<7> [375.356991] i915 0000:00:02.0: pixel repeat: 0
<7> [375.356994] i915 0000:00:02.0: bar top 0, bottom 0, left 0, right 0
<7> [375.356998] i915 0000:00:02.0: HDMI infoframe: Source Product Description (SPD), version 1, length 25
<7> [375.357001] i915 0000:00:02.0: vendor: Intel
<7> [375.357005] i915 0000:00:02.0: product: Integrated gfx
<7> [375.357008] i915 0000:00:02.0: source device information: PC General (0x9)
<7> [375.357012] i915 0000:00:02.0: HDMI infoframe: Vendor, version 1, length 4
<7> [375.357015] i915 0000:00:02.0: empty frame
<7> [375.357019] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] ELD: 10 00 07 00 66 10 00 01 00 00 00 00 00 00 00 00
<7> [375.357395] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] ELD: 05 e3 cd 0c 32 38 45 38 35 30 09 07 07 00 00 00
<7> [375.359551] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] scanline offset: 2
<7> [375.360038] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [375.360419] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: no, fixed rr: no, vmin: 0, vmax: 0, flipline: 0, pipeline full: 0, guardband: 0 vsync start: 0, vsync end: 0
<7> [375.360824] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: vmin vblank: 0, vmax vblank: 0, vmin vtotal: 0, vmax vtotal: 0
<7> [375.361198] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: dc balance: no, vmin: 0 vmax: 0 guardband: 0, slope: 0 max increase: 0 max decrease: 0 vblank target: 0
<7> [375.362561] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] requested mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1083 1088 1125 0x48 0x9
<7> [375.363028] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] adjusted mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1083 1088 1125 0x48 0x9
<7> [375.363408] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=148500, hd=1920 hb=1920-2200 hs=2008-2052 ht=2200, vd=1080 vb=1080-1125 vs=1083-1088 vt=1125, flags=0x9
<7> [375.364099] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe mode: "1920x1080": 60 148500 1920 2008 2052 2200 1080 1083 1088 1125 0x40 0x9
<7> [375.364600] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=148500, hd=1920 hb=1920-2200 hs=2008-2052 ht=2200, vd=1080 vb=1080-1125 vs=1083-1088 vt=1125, flags=0x9
<7> [375.364981] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port clock: 222750, pipe src: 1920x1080+0+0, pixel rate 148500, min cdclk 192000
<7> [375.365357] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] linetime: 59, ips linetime: 0
<7> [375.365862] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0
<7> [375.366241] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [375.366654] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] ips: 0, double wide: 0, drrs: 0
<7> [375.367048] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] dpll_hw_state: ebb0: 0x6200, ebb4: 0x2000,pll0: 0x21, pll1: 0x100, pll2: 0x1a6666, pll3: 0x10000, pll6: 0x30904, pll8: 0x8, pll9: 0xa, pll10: 0x8003c00, pcsdw12: 0x4d
<7> [375.367428] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] csc_mode: 0x0 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [375.367863] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [375.368260] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [375.368684] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [375.369059] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [375.369431] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [375.369864] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [375.370241] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [375.372657] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:35:plane 1A] fb: [FB:181] 1920x1080 format = XR24 little-endian (0x34325258) modifier = 0x100000000000001, visible: yes
<7> [375.373231] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [375.373661] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] src: 1920.000000x1080.000000+0.000000+0.000000 dst: 1920x1080+0+0
<7> [375.374039] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:44:plane 2A] fb: [NOFB], visible: no
<7> [375.374416] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:53:plane 3A] fb: [NOFB], visible: no
<7> [375.375076] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:62:plane 4A] fb: [NOFB], visible: no
<7> [375.375580] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:71:cursor A] fb: [NOFB], visible: no
<7> [375.376818] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling always-on
<7> [375.377221] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DC_off
<7> [375.378145] i915 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [i915]] Setting DC state from 01 to 00
<7> [375.379297] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling PW_2
<7> [375.379865] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling dpio-common-b
<7> [375.380618] i915 0000:00:02.0: [drm:intel_set_cdclk [i915]] Pre changing CDCLK to 316800 kHz, VCO 633600 kHz, ref 19200 kHz, bypass 19200 kHz, voltage level 13
<7> [375.381080] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:164:DDI B/PHY B]
<7> [375.383501] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:174:DDI C/PHY C]
<7> [375.384246] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enable PORT PLL B (active 0x1, on? 0) for [CRTC:77:pipe A]
<7> [375.384920] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enabling PORT PLL B
<7> [375.385650] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DDI_IO_B
<7> [375.386137] i915 0000:00:02.0: [drm:intel_enable_transcoder [i915]] enabling pipe A
<7> [375.387535] i915 0000:00:02.0: [drm:intel_fbc_update [i915]] reserved 16588800 bytes of contiguous stolen space for FBC, limit: 1
<7> [375.387931] i915 0000:00:02.0: [drm:intel_fbc_update [i915]] Enabling FBC on [PLANE:35:plane 1A]
<7> [375.404267] i915 0000:00:02.0: [drm:intel_audio_codec_enable [i915]] [CONNECTOR:165:HDMI-A-1][ENCODER:164:DDI B/PHY B] Enable audio codec on [CRTC:77:pipe A], 32 bytes ELD
<7> [375.418039] i915 0000:00:02.0: [drm:intel_audio_component_get_power [i915]] restored AUD_FREQ_CNTRL to 0x10
<7> [375.421515] i915 0000:00:02.0: [drm:audio_config_hdmi_pixel_clock [i915]] Configuring HDMI audio for pixel clock 148500 (0x00090000)
<7> [375.421998] i915 0000:00:02.0: [drm:hsw_audio_config_update [i915]] using automatic N
<7> [375.422595] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:165:HDMI-A-1]
<7> [375.423168] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:77:pipe A]
<7> [375.429565] azx_init_pci: snd_hda_intel 0000:00:0e.0: Clearing TCSEL
<7> [375.429586] azx_init_pci: snd_hda_intel 0000:00:0e.0: SCH snoop: Enabled
<6> [380.079937] [IGT] kms_flip: finished subtest A-HDMI-A1, FAIL
Created at 2026-03-07 01:21:49