2022-06-06 16:36:36,975 INFO [streaming_decode.py:640] Decoding started
2022-06-06 16:36:36,975 INFO [streaming_decode.py:646] Device: cuda:0
2022-06-06 16:36:36,978 INFO [streaming_decode.py:660] {'best_train_loss': inf, 'best_valid_loss': inf, 'best_train_epoch': -1, 'best_valid_epoch': -1, 'batch_idx_train': 0, 'log_interval': 50, 'reset_interval': 200, 'valid_interval': 3000, 'feature_dim': 80, 'subsampling_factor': 4, 'encoder_dim': 512, 'nhead': 8, 'dim_feedforward': 2048, 'cnn_module_kernel': 31, 'num_encoder_layers': 12, 'decoder_dim': 512, 'joiner_dim': 512, 'model_warm_step': 3000, 'env_info': {'k2-version': '1.15.1', 'k2-build-type': 'Release', 'k2-with-cuda': True, 'k2-git-sha1': 'f8d2dba06c000ffee36aab5b66f24e7c9809f116', 'k2-git-date': 'Thu Apr 21 12:20:34 2022', 'lhotse-version': '1.1.0', 'torch-version': '1.10.0+cu102', 'torch-cuda-available': True, 'torch-cuda-version': '10.2', 'python-version': '3.8', 'icefall-git-branch': 'streaming-conformer', 'icefall-git-sha1': '3aacf75-dirty', 'icefall-git-date': 'Mon Jun 6 06:46:40 2022', 'icefall-path': '/ceph-kw/kangwei/code/icefall_reworked2', 'k2-path': '/ceph-hw/kangwei/code/k2_release/k2/k2/python/k2/__init__.py', 'lhotse-path': '/ceph-hw/kangwei/dev_tools/anaconda3/envs/rnnt2/lib/python3.8/site-packages/lhotse-1.1.0-py3.8.egg/lhotse/__init__.py', 'hostname': 'de-74279-k2-train-3-0602204318-5799c545db-hhjfr', 'IP address': '10.177.24.137'}, 'epoch': 29, 'iter': 0, 'avg': 6, 'use_averaged_model': False, 'exp_dir': PosixPath('streaming_pruned_transducer_stateless4/exp'), 'bpe_model': 'data/lang_bpe_500/bpe.model', 'decoding_method': 'greedy_search', 'beam': 4, 'max_contexts': 4, 'max_states': 32, 'context_size': 2, 'dynamic_chunk_training': False, 'short_chunk_size': 25, 'num_left_chunks': 4, 'causal_convolution': True, 'decode_chunk_size': 16, 'left_context': 64, 'right_context': 4, 'num_decode_streams': 1000, 'full_libri': True, 'manifest_dir': PosixPath('data/fbank'), 'max_duration': 200.0, 'bucketing_sampler': True, 'num_buckets': 30, 'concatenate_cuts': False, 'duration_factor': 1.0, 'gap': 1.0, 'on_the_fly_feats': False, 'shuffle': True, 'return_cuts': True, 'num_workers': 2, 'enable_spec_aug': True, 'spec_aug_time_warp_factor': 80, 'enable_musan': True, 'res_dir': PosixPath('streaming_pruned_transducer_stateless4/exp/streaming/greedy_search'), 'suffix': 'epoch-29-avg-6-streaming-chunk-size-16-left-context-64-right-context-4', 'blank_id': 0, 'unk_id': 2, 'vocab_size': 500}
2022-06-06 16:36:36,978 INFO [streaming_decode.py:662] About to create model
2022-06-06 16:36:37,420 INFO [streaming_decode.py:691] averaging ['streaming_pruned_transducer_stateless4/exp/epoch-24.pt', 'streaming_pruned_transducer_stateless4/exp/epoch-25.pt', 'streaming_pruned_transducer_stateless4/exp/epoch-26.pt', 'streaming_pruned_transducer_stateless4/exp/epoch-27.pt', 'streaming_pruned_transducer_stateless4/exp/epoch-28.pt', 'streaming_pruned_transducer_stateless4/exp/epoch-29.pt']
2022-06-06 16:36:53,456 INFO [streaming_decode.py:751] Number of model parameters: 78648040
2022-06-06 16:36:53,457 INFO [asr_datamodule.py:422] About to get test-clean cuts
2022-06-06 16:36:53,585 INFO [asr_datamodule.py:427] About to get test-other cuts
2022-06-06 16:36:53,888 INFO [streaming_decode.py:537] Cuts processed until now is 0.
2022-06-06 16:36:54,239 INFO [streaming_decode.py:537] Cuts processed until now is 50.
2022-06-06 16:36:54,506 INFO [streaming_decode.py:537] Cuts processed until now is 100.
2022-06-06 16:36:54,755 INFO [streaming_decode.py:537] Cuts processed until now is 150.
2022-06-06 16:36:55,137 INFO [streaming_decode.py:537] Cuts processed until now is 200.
2022-06-06 16:36:55,434 INFO [streaming_decode.py:537] Cuts processed until now is 250.
2022-06-06 16:36:55,778 INFO [streaming_decode.py:537] Cuts processed until now is 300.
2022-06-06 16:36:56,196 INFO [streaming_decode.py:537] Cuts processed until now is 350.
2022-06-06 16:36:56,520 INFO [streaming_decode.py:537] Cuts processed until now is 400.
2022-06-06 16:36:56,837 INFO [streaming_decode.py:537] Cuts processed until now is 450.
2022-06-06 16:36:57,179 INFO [streaming_decode.py:537] Cuts processed until now is 500.
2022-06-06 16:36:57,535 INFO [streaming_decode.py:537] Cuts processed until now is 550.
2022-06-06 16:36:57,899 INFO [streaming_decode.py:537] Cuts processed until now is 600.
2022-06-06 16:36:58,225 INFO [streaming_decode.py:537] Cuts processed until now is 650.
2022-06-06 16:36:58,590 INFO [streaming_decode.py:537] Cuts processed until now is 700.
2022-06-06 16:36:58,901 INFO [streaming_decode.py:537] Cuts processed until now is 750.
2022-06-06 16:36:59,256 INFO [streaming_decode.py:537] Cuts processed until now is 800.
2022-06-06 16:36:59,553 INFO [streaming_decode.py:537] Cuts processed until now is 850.
2022-06-06 16:36:59,855 INFO [streaming_decode.py:537] Cuts processed until now is 900.
2022-06-06 16:37:00,151 INFO [streaming_decode.py:537] Cuts processed until now is 950.
2022-06-06 16:37:03,309 INFO [streaming_decode.py:537] Cuts processed until now is 1000.
2022-06-06 16:37:04,480 INFO [streaming_decode.py:537] Cuts processed until now is 1050.
2022-06-06 16:37:05,700 INFO [streaming_decode.py:537] Cuts processed until now is 1100.
2022-06-06 16:37:06,002 INFO [streaming_decode.py:537] Cuts processed until now is 1150.
2022-06-06 16:37:07,254 INFO [streaming_decode.py:537] Cuts processed until now is 1200.
2022-06-06 16:37:07,601 INFO [streaming_decode.py:537] Cuts processed until now is 1250.
2022-06-06 16:37:08,766 INFO [streaming_decode.py:537] Cuts processed until now is 1300.
2022-06-06 16:37:09,068 INFO [streaming_decode.py:537] Cuts processed until now is 1350.
2022-06-06 16:37:10,350 INFO [streaming_decode.py:537] Cuts processed until now is 1400.
2022-06-06 16:37:10,627 INFO [streaming_decode.py:537] Cuts processed until now is 1450.
2022-06-06 16:37:12,005 INFO [streaming_decode.py:537] Cuts processed until now is 1500.
2022-06-06 16:37:13,207 INFO [streaming_decode.py:537] Cuts processed until now is 1550.
2022-06-06 16:37:13,503 INFO [streaming_decode.py:537] Cuts processed until now is 1600.
2022-06-06 16:37:14,698 INFO [streaming_decode.py:537] Cuts processed until now is 1650.
2022-06-06 16:37:14,993 INFO [streaming_decode.py:537] Cuts processed until now is 1700.
2022-06-06 16:37:16,203 INFO [streaming_decode.py:537] Cuts processed until now is 1750.
2022-06-06 16:37:17,419 INFO [streaming_decode.py:537] Cuts processed until now is 1800.
2022-06-06 16:37:17,690 INFO [streaming_decode.py:537] Cuts processed until now is 1850.
2022-06-06 16:37:18,994 INFO [streaming_decode.py:537] Cuts processed until now is 1900.
2022-06-06 16:37:19,253 INFO [streaming_decode.py:537] Cuts processed until now is 1950.
2022-06-06 16:37:20,462 INFO [streaming_decode.py:537] Cuts processed until now is 2000.
2022-06-06 16:37:21,509 INFO [streaming_decode.py:537] Cuts processed until now is 2050.
2022-06-06 16:37:21,809 INFO [streaming_decode.py:537] Cuts processed until now is 2100.
2022-06-06 16:37:22,933 INFO [streaming_decode.py:537] Cuts processed until now is 2150.
2022-06-06 16:37:24,006 INFO [streaming_decode.py:537] Cuts processed until now is 2200.
2022-06-06 16:37:24,315 INFO [streaming_decode.py:537] Cuts processed until now is 2250.
2022-06-06 16:37:25,687 INFO [streaming_decode.py:537] Cuts processed until now is 2300.
2022-06-06 16:37:25,937 INFO [streaming_decode.py:537] Cuts processed until now is 2350.
2022-06-06 16:37:27,262 INFO [streaming_decode.py:537] Cuts processed until now is 2400.
2022-06-06 16:37:28,433 INFO [streaming_decode.py:537] Cuts processed until now is 2450.
2022-06-06 16:37:28,757 INFO [streaming_decode.py:537] Cuts processed until now is 2500.
2022-06-06 16:37:29,949 INFO [streaming_decode.py:537] Cuts processed until now is 2550.
2022-06-06 16:37:30,247 INFO [streaming_decode.py:537] Cuts processed until now is 2600.
2022-06-06 16:37:40,053 INFO [streaming_decode.py:575] The transcripts are stored in streaming_pruned_transducer_stateless4/exp/streaming/greedy_search/recogs-test-clean-greedy_search-epoch-29-avg-6-streaming-chunk-size-16-left-context-64-right-context-4.txt
2022-06-06 16:37:40,123 INFO [utils.py:405] [test-clean-greedy_search] %WER 3.31% [1741 / 52576, 184 ins, 151 del, 1406 sub ]
2022-06-06 16:37:40,368 INFO [streaming_decode.py:588] Wrote detailed error stats to streaming_pruned_transducer_stateless4/exp/streaming/greedy_search/errs-test-clean-greedy_search-epoch-29-avg-6-streaming-chunk-size-16-left-context-64-right-context-4.txt
2022-06-06 16:37:40,369 INFO [streaming_decode.py:605] 
For test-clean, WER of different settings are:
greedy_search	3.31	best for test-clean

2022-06-06 16:37:40,374 INFO [streaming_decode.py:537] Cuts processed until now is 0.
2022-06-06 16:37:40,656 INFO [streaming_decode.py:537] Cuts processed until now is 50.
2022-06-06 16:37:40,909 INFO [streaming_decode.py:537] Cuts processed until now is 100.
2022-06-06 16:37:41,275 INFO [streaming_decode.py:537] Cuts processed until now is 150.
2022-06-06 16:37:41,522 INFO [streaming_decode.py:537] Cuts processed until now is 200.
2022-06-06 16:37:41,740 INFO [streaming_decode.py:537] Cuts processed until now is 250.
2022-06-06 16:37:42,000 INFO [streaming_decode.py:537] Cuts processed until now is 300.
2022-06-06 16:37:42,216 INFO [streaming_decode.py:537] Cuts processed until now is 350.
2022-06-06 16:37:42,456 INFO [streaming_decode.py:537] Cuts processed until now is 400.
2022-06-06 16:37:42,723 INFO [streaming_decode.py:537] Cuts processed until now is 450.
2022-06-06 16:37:42,949 INFO [streaming_decode.py:537] Cuts processed until now is 500.
2022-06-06 16:37:43,199 INFO [streaming_decode.py:537] Cuts processed until now is 550.
2022-06-06 16:37:43,435 INFO [streaming_decode.py:537] Cuts processed until now is 600.
2022-06-06 16:37:43,761 INFO [streaming_decode.py:537] Cuts processed until now is 650.
2022-06-06 16:37:43,963 INFO [streaming_decode.py:537] Cuts processed until now is 700.
2022-06-06 16:37:44,180 INFO [streaming_decode.py:537] Cuts processed until now is 750.
2022-06-06 16:37:44,370 INFO [streaming_decode.py:537] Cuts processed until now is 800.
2022-06-06 16:37:44,571 INFO [streaming_decode.py:537] Cuts processed until now is 850.
2022-06-06 16:37:44,827 INFO [streaming_decode.py:537] Cuts processed until now is 900.
2022-06-06 16:37:45,124 INFO [streaming_decode.py:537] Cuts processed until now is 950.
2022-06-06 16:37:47,536 INFO [streaming_decode.py:537] Cuts processed until now is 1000.
2022-06-06 16:37:48,481 INFO [streaming_decode.py:537] Cuts processed until now is 1050.
2022-06-06 16:37:48,769 INFO [streaming_decode.py:537] Cuts processed until now is 1100.
2022-06-06 16:37:49,868 INFO [streaming_decode.py:537] Cuts processed until now is 1150.
2022-06-06 16:37:50,092 INFO [streaming_decode.py:537] Cuts processed until now is 1200.
2022-06-06 16:37:51,101 INFO [streaming_decode.py:537] Cuts processed until now is 1250.
2022-06-06 16:37:51,356 INFO [streaming_decode.py:537] Cuts processed until now is 1300.
2022-06-06 16:37:52,299 INFO [streaming_decode.py:537] Cuts processed until now is 1350.
2022-06-06 16:37:52,581 INFO [streaming_decode.py:537] Cuts processed until now is 1400.
2022-06-06 16:37:53,573 INFO [streaming_decode.py:537] Cuts processed until now is 1450.
2022-06-06 16:37:53,829 INFO [streaming_decode.py:537] Cuts processed until now is 1500.
2022-06-06 16:37:54,815 INFO [streaming_decode.py:537] Cuts processed until now is 1550.
2022-06-06 16:37:55,939 INFO [streaming_decode.py:537] Cuts processed until now is 1600.
2022-06-06 16:37:56,213 INFO [streaming_decode.py:537] Cuts processed until now is 1650.
2022-06-06 16:37:57,223 INFO [streaming_decode.py:537] Cuts processed until now is 1700.
2022-06-06 16:37:57,476 INFO [streaming_decode.py:537] Cuts processed until now is 1750.
2022-06-06 16:37:58,451 INFO [streaming_decode.py:537] Cuts processed until now is 1800.
2022-06-06 16:37:58,764 INFO [streaming_decode.py:537] Cuts processed until now is 1850.
2022-06-06 16:37:59,955 INFO [streaming_decode.py:537] Cuts processed until now is 1900.
2022-06-06 16:38:00,170 INFO [streaming_decode.py:537] Cuts processed until now is 1950.
2022-06-06 16:38:01,326 INFO [streaming_decode.py:537] Cuts processed until now is 2000.
2022-06-06 16:38:01,634 INFO [streaming_decode.py:537] Cuts processed until now is 2050.
2022-06-06 16:38:02,858 INFO [streaming_decode.py:537] Cuts processed until now is 2100.
2022-06-06 16:38:03,130 INFO [streaming_decode.py:537] Cuts processed until now is 2150.
2022-06-06 16:38:04,343 INFO [streaming_decode.py:537] Cuts processed until now is 2200.
2022-06-06 16:38:04,634 INFO [streaming_decode.py:537] Cuts processed until now is 2250.
2022-06-06 16:38:05,860 INFO [streaming_decode.py:537] Cuts processed until now is 2300.
2022-06-06 16:38:07,084 INFO [streaming_decode.py:537] Cuts processed until now is 2350.
2022-06-06 16:38:07,378 INFO [streaming_decode.py:537] Cuts processed until now is 2400.
2022-06-06 16:38:08,600 INFO [streaming_decode.py:537] Cuts processed until now is 2450.
2022-06-06 16:38:08,896 INFO [streaming_decode.py:537] Cuts processed until now is 2500.
2022-06-06 16:38:10,112 INFO [streaming_decode.py:537] Cuts processed until now is 2550.
2022-06-06 16:38:10,340 INFO [streaming_decode.py:537] Cuts processed until now is 2600.
2022-06-06 16:38:11,659 INFO [streaming_decode.py:537] Cuts processed until now is 2650.
2022-06-06 16:38:11,892 INFO [streaming_decode.py:537] Cuts processed until now is 2700.
2022-06-06 16:38:13,111 INFO [streaming_decode.py:537] Cuts processed until now is 2750.
2022-06-06 16:38:13,372 INFO [streaming_decode.py:537] Cuts processed until now is 2800.
2022-06-06 16:38:14,527 INFO [streaming_decode.py:537] Cuts processed until now is 2850.
2022-06-06 16:38:14,751 INFO [streaming_decode.py:537] Cuts processed until now is 2900.
2022-06-06 16:38:25,178 INFO [streaming_decode.py:575] The transcripts are stored in streaming_pruned_transducer_stateless4/exp/streaming/greedy_search/recogs-test-other-greedy_search-epoch-29-avg-6-streaming-chunk-size-16-left-context-64-right-context-4.txt
2022-06-06 16:38:25,276 INFO [utils.py:405] [test-other-greedy_search] %WER 8.58% [4491 / 52343, 441 ins, 499 del, 3551 sub ]
2022-06-06 16:38:25,492 INFO [streaming_decode.py:588] Wrote detailed error stats to streaming_pruned_transducer_stateless4/exp/streaming/greedy_search/errs-test-other-greedy_search-epoch-29-avg-6-streaming-chunk-size-16-left-context-64-right-context-4.txt
2022-06-06 16:38:25,492 INFO [streaming_decode.py:605] 
For test-other, WER of different settings are:
greedy_search	8.58	best for test-other

2022-06-06 16:38:25,493 INFO [streaming_decode.py:776] Done!