Tools and Tasks tests for Python 3.12

Build: #257 did not complete

Job: Test Tools Many Linux 2.28 Rocky 8.10 Py3.12 was successful

Build log

The build generated 53,401 lines of output.   The output is too long and has been truncated to the last 1,000 lines. Download or view full build log.

15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  FLAGVER =   1 /Flagging table used
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  UVRANGE(1)= 0.00000E+00 /Min. uv used
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  UVRANGE(2)= 0.00000E+00 /Max. uv used
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS IN2NAME='            '   IN2CLASS='      '
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS IN2SEQ=    0   IN2DISK=  0
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  INVER =     1 /CC file version no.
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  NMAPS =   0 /Number of clean images used
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS /TIMERANG = beginning to end
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  SOLINT = 0.0 /Scan average
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  SUBARRAY =   0
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  REFANT =   15 /Reference antenna
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  Dividing data by channel 0
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  External channel 0 filename:
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS IN3NAME='13/04/95    '   IN3CLASS='CH 0  '
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS IN3SEQ=    1   IN3DISK=  4
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS  ANTWT=  1.0  1.0  1.0  1.0  1.0  1.0  1.0  1.0  1.0 /Ant. wt
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS         1.0  1.0  1.0  1.0  1.0  1.0  1.0  1.0  1.0
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS         1.0  1.0  1.0  1.0  1.0  1.0  1.0  1.0  1.0
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        BPASS         1.0  1.0
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        POSSM  VERSION=  1  / plot file created 15-JUN-1998 17:37:18
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        POSSM  VERSION=  2  / plot file created 15-JUN-1998 17:37:43
15-Apr-2026 14:47:25 1995-04-13 00:00:00        INFO        ::MSFitsInput::fillObsTables        POSSM  VERSION=  3  / plot file created 15-JUN-1998 17:38:24
15-Apr-2026 14:47:25 2010-02-22 16:55:31        INFO        ::importuvfits        taskname     = importuvfits
15-Apr-2026 14:47:25 2010-02-22 16:55:31        INFO        ::importuvfits        fitsfile     = "/opt/casa/data/regression/ngc5921/ngc5921.fits"
15-Apr-2026 14:47:25 2010-02-22 16:55:31        INFO        ::importuvfits        vis          = "ngc5921_ut.ms"
15-Apr-2026 14:47:25 2010-02-22 16:55:31        INFO        ::importuvfits        antnamescheme= "old"
15-Apr-2026 14:47:25 2026-04-15 18:48:03        INFO        ::MSHistoryHandler::addMessage()        an arbitrary history message
15-Apr-2026 14:47:25 test_tool_ms.py::mstool_test_summary::test_writehistory
15-Apr-2026 14:47:25 test ms.writehistory
15-Apr-2026 14:47:25 PASSED
15-Apr-2026 14:47:25
15-Apr-2026 14:47:25 test_tool_ms.py::mstool_test_select::test_msselect
15-Apr-2026 14:47:25 test ms.msselect, ms.msselectedindices, ms.reset
15-Apr-2026 14:47:25 PASSED
15-Apr-2026 14:47:25
15-Apr-2026 14:47:25 test_tool_ms.py::mstool_test_select::test_msselect_timerange
15-Apr-2026 14:47:25 test ms.msselect with timerange selection
15-Apr-2026 14:47:25 PASSED
15-Apr-2026 14:47:25
15-Apr-2026 14:47:26 test_tool_ms.py::mstool_test_select::test_msseltoindex
15-Apr-2026 14:47:26 test ms.msseltoindex
15-Apr-2026 14:47:26 PASSED
15-Apr-2026 14:47:26
15-Apr-2026 14:47:26 test_tool_ms.py::mstool_test_select::test_select
15-Apr-2026 14:47:26 test ms.select
15-Apr-2026 14:47:26 PASSED
15-Apr-2026 14:47:26
15-Apr-2026 14:47:26 2026-04-15 18:47:26        WARN        ms::msselect        MSSelectionNullSelection : The selected table has zero rows.
15-Apr-2026 14:47:26 2026-04-15 18:47:26        WARN        ms::getdata        Selected table is empty, cannot get data
15-Apr-2026 14:47:26 test_tool_ms.py::mstool_test_select::test_select_getdata_empty
15-Apr-2026 14:47:26 test ms.select() and ms.getdata() with empty selection
15-Apr-2026 14:47:26 PASSED
15-Apr-2026 14:47:26
15-Apr-2026 14:47:26 2026-04-15 18:47:27        INFO        ChannelAverageTVI::parseConfiguration        Channel bin is [5]
15-Apr-2026 14:47:26 2026-04-15 18:47:27        SEVERE        ms::selectchannel        Illegal channel selection
15-Apr-2026 14:47:26 test_tool_ms.py::mstool_test_select::test_selectchannel
15-Apr-2026 14:47:26 test ms.selectchannel
15-Apr-2026 14:47:26
15-Apr-2026 14:47:26 Test invalid channel selection:
15-Apr-2026 14:47:26 PASSED
15-Apr-2026 14:47:26
15-Apr-2026 14:47:26 test_tool_ms.py::mstool_test_select::test_selectinit
15-Apr-2026 14:47:26 test ms.selectinit, ms.nrow
15-Apr-2026 14:47:26 PASSED
15-Apr-2026 14:47:26
15-Apr-2026 14:47:28 test_tool_ms.py::mstool_test_select::test_selectpolarization
15-Apr-2026 14:47:28 test ms.selectpolarization
15-Apr-2026 14:47:28 PASSED
15-Apr-2026 14:47:28
15-Apr-2026 14:47:28 test_tool_ms.py::mstool_test_select::test_selecttaql
15-Apr-2026 14:47:28 test ms.selecttaql
15-Apr-2026 14:47:28 PASSED
15-Apr-2026 14:47:28
15-Apr-2026 14:47:28 test_tool_ms.py::mstool_test_getdata::test_getsigma
15-Apr-2026 14:47:28 test ms.getdata, sigma
15-Apr-2026 14:47:28 PASSED
15-Apr-2026 14:47:28
15-Apr-2026 14:47:28 2026-04-15 18:47:29        INFO        ChannelAverageTVI::parseConfiguration        Channel bin is [63]
15-Apr-2026 14:47:28 test_tool_ms.py::mstool_test_getdata::test_getsigma_channavg
15-Apr-2026 14:47:28 test ms.getdata, sigma channavg
15-Apr-2026 14:47:28 PASSED
15-Apr-2026 14:47:28
15-Apr-2026 14:47:28 test_tool_ms.py::mstool_test_getdata::test_getweights
15-Apr-2026 14:47:28 test ms.getdata, weight
15-Apr-2026 14:47:28 PASSED
15-Apr-2026 14:47:28
15-Apr-2026 14:47:28 2026-04-15 18:47:29        INFO        ChannelAverageTVI::parseConfiguration        Channel bin is [63]
15-Apr-2026 14:47:28 test_tool_ms.py::mstool_test_getdata::test_getweights_channavg
15-Apr-2026 14:47:28 test ms.getdata, weight, channavg
15-Apr-2026 14:47:28 PASSED
15-Apr-2026 14:47:28
15-Apr-2026 14:47:29 2026-04-15 18:47:29        INFO        VisSet::addCalSet        Adding MODEL_DATA and CORRECTED_DATA columns
15-Apr-2026 14:47:29 2026-04-15 18:47:29        INFO        VisSet::VisSet        Initializing MODEL_DATA (to unity) and CORRECTED_DATA (to DATA)
15-Apr-2026 14:47:29 2026-04-15 18:47:29        INFO        VisSet::VisSet        Initialized 22653 rows.
15-Apr-2026 14:47:29 2026-04-15 18:47:29        INFO        MSContinuumSubtractor::setSolutionInterval        Fitting continuum on 0-second (per scan) timescale.
15-Apr-2026 14:47:29 2026-04-15 18:47:29        INFO        MSContinuumSubtractor::subtract2        parameters:
15-Apr-2026 14:47:29 2026-04-15 18:47:29        INFO        MSContinuumSubtractor::subtract2           ddIds=[0], fieldIds=[1], order=0, mode=subtract
15-Apr-2026 14:47:29 2026-04-15 18:47:30        INFO        MSContinuumSubtractor::subtract2        Processing 4 slots for ddId 0
15-Apr-2026 14:47:30 2026-04-15 18:47:31        INFO        SubMS::parseColumnNames()        Using CORRECTED_DATA column.
15-Apr-2026 14:47:30 2026-04-15 18:47:31        INFO        SubMS::makeSelection()        4509 out of 22653 rows are going to be considered due to the selection criteria.
15-Apr-2026 14:47:31 test_tool_ms.py::mstool_test_transform::test_continuum_uv_cont_sub
15-Apr-2026 14:47:31 test ms.continuumsub, uvsub, contsub
15-Apr-2026 14:47:31 PASSED
15-Apr-2026 14:47:31
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        ms::cvel        Input spectral window 0 has 63 channels of width 2.441406e+04 Hz
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        ms::cvel+           First channel center = 1.412665074e+09 Hz, last channel center = 1.414178746e+09 Hz
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        ms::cvel        Starting combination of spectral windows ...
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::combineSpws()        Less than two SPWs selected. No combination necessary.
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        ms::cvel        
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        ms::cvel        Testing if spectral frame transformation/regridding is needed ...
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()        Using tabulated observatory position for VLA:
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()           Position: [-1.60119e+06, -5.04198e+06, 3.55488e+06] (ITRF)
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()        Regridded spectral window 0 will be created for field 0 with parameters
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+        input frame = LSRK, output frame = LSRK
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+         Channels equidistant in freq
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+         Central frequency (in output frame) = 1.41341e+09 Hz
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+         Width of central channel (in output frame) = 48828.1 Hz
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+         Number of channels = 31
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+         Total width of SPW (in output frame) = 1.51367e+06 Hz
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+         Lower edge = 1.41265e+09 Hz, upper edge = 1.41417e+09 Hz
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+         Interpolation Method = linear
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()        Added 1 new rows to the DATA_DESCRIPTION table and deleted 1 old ones.
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+        Added 1 rows to the SPECTRAL_WINDOW table and deleted 1 old ones.
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()+        Added 1 rows to the SOURCE table and deleted 3 old ones.
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()        Main table data array columns will be rewritten.
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()        The following columns will be Hanning-smoothed before regridding:
15-Apr-2026 14:47:31 2026-04-15 18:47:32        INFO        SubMS::regridSpw()         DATA
15-Apr-2026 14:47:31 test_tool_ms.py::mstool_test_transform::test_cvel regridSpw progress: 20% processed ...
15-Apr-2026 14:47:32 regridSpw progress: 40% processed ...
15-Apr-2026 14:47:32 regridSpw progress: 60% processed ...
15-Apr-2026 14:47:32 regridSpw progress: 80% processed ...
15-Apr-2026 14:47:32 regridSpw progress: 100% processed.
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        ms::cvel        Spectral frame transformation/regridding completed.
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        ms::cvel        Hanning smoothing was applied.
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        ms::cvel        Final spectral window has 31 channels of width 4.882812e+04 Hz
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        ms::cvel+        First channel center = 1.412677281e+09 Hz, last channel center = 1.414142125e+09 Hz
15-Apr-2026 14:47:32
15-Apr-2026 14:47:32 test ms.cvel
15-Apr-2026 14:47:32 PASSED
15-Apr-2026 14:47:32
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        ms::cvelfreqs        Calculating grid ...
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        ms::cvelfreqs        Using observation time from earliest row of the MS given the SPW and FIELD selection:
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        ms::cvelfreqs            1995/04/13/09:19:00 (TAI)
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        ms::cvelfreqs        Using tabulated observatory position for VLA:
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        ms::cvelfreqs           Position: [-1.60119e+06, -5.04198e+06, 3.55488e+06] (ITRF)
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        SubMS::convertGridPars         Channels equidistant in freq
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        SubMS::convertGridPars+         Central frequency (in output frame) = 1.41341e+09 Hz
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        SubMS::convertGridPars+         Width of central channel (in output frame) = 48828.1 Hz
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        SubMS::convertGridPars+         Number of channels = 31
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        SubMS::convertGridPars+         Total width of SPW (in output frame) = 1.51367e+06 Hz
15-Apr-2026 14:47:32 2026-04-15 18:47:33        INFO        SubMS::convertGridPars+         Lower edge = 1.41265e+09 Hz, upper edge = 1.41417e+09 Hz
15-Apr-2026 14:47:32 test_tool_ms.py::mstool_test_transform::test_cvelfreqs
15-Apr-2026 14:47:32 test ms.cvelfreqs
15-Apr-2026 14:47:32 PASSED
15-Apr-2026 14:47:32
15-Apr-2026 14:47:33 2026-04-15 18:47:33        INFO        ms::hanningsmooth        Smoothing MS Main Table column 'data'
15-Apr-2026 14:47:33 test_tool_ms.py::mstool_test_transform::test_hanningsmooth
15-Apr-2026 14:47:33 test ms.hanningsmooth
15-Apr-2026 14:47:33 PASSED
15-Apr-2026 14:47:33
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        ms::regridspw        Starting spectral frame transformation / regridding ...
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()        Using tabulated observatory position for VLA:
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()           Position: [-1.60119e+06, -5.04198e+06, 3.55488e+06] (ITRF)
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()        Regridded spectral window 0 will be created for field 0 with parameters
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+        input frame = LSRK, output frame = LSRK
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+         New channels defined based on original channels
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+         Central channel contains original channel 24
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+         Channel width = 2 original channels
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+         Total width of SPW = 32 original channels == 16 new channels
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+         Total width of SPW (in output frame) = 781250 Hz
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+         Lower edge = 1.41285e+09 Hz, upper edge = 1.41363e+09 Hz
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+         Interpolation Method = linear
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()        Added 1 new rows to the DATA_DESCRIPTION table and deleted 1 old ones.
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+        Added 1 rows to the SPECTRAL_WINDOW table and deleted 1 old ones.
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()+        Added 3 rows to the SOURCE table and deleted 3 old ones.
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()        Main table data array columns will be rewritten.
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()        The following columns will be Hanning-smoothed before regridding:
15-Apr-2026 14:47:33 2026-04-15 18:47:34        INFO        SubMS::regridSpw()         DATA
15-Apr-2026 14:47:33 test_tool_ms.py::mstool_test_transform::test_regridspw regridSpw progress: 20% processed ...
15-Apr-2026 14:47:34 regridSpw progress: 40% processed ...
15-Apr-2026 14:47:34 regridSpw progress: 60% processed ...
15-Apr-2026 14:47:34 regridSpw progress: 80% processed ...
15-Apr-2026 14:47:34 regridSpw progress: 100% processed.
15-Apr-2026 14:47:34 2026-04-15 18:47:35        INFO        ms::regridspw        Spectral frame transformation/regridding completed.
15-Apr-2026 14:47:34
15-Apr-2026 14:47:34 test ms.regridspw
15-Apr-2026 14:47:34 PASSED
15-Apr-2026 14:47:34
15-Apr-2026 14:47:34 2026-04-15 18:47:35        INFO        Reweighter::makeSelection()        4509 out of 22653 rows are going to be considered due to the selection criteria.
15-Apr-2026 14:47:34 test_tool_ms.py::mstool_test_transform::test_statwt
15-Apr-2026 14:47:34 test ms.statwt
15-Apr-2026 14:47:34 PASSED
15-Apr-2026 14:47:34
15-Apr-2026 14:47:37 test_tool_ms.py::mstool_test_dataIO::test_getdata_args
15-Apr-2026 14:47:37 test ms.getdata ifraxis, increment, and average
15-Apr-2026 14:47:37 PASSED
15-Apr-2026 14:47:37
15-Apr-2026 14:47:38 test_tool_ms.py::mstool_test_dataIO::test_getdata_average
15-Apr-2026 14:47:38 PASSED
15-Apr-2026 14:47:38
15-Apr-2026 14:47:38 2026-04-15 18:47:39        INFO        calibrater::open        ****Using NEW VI2-driven calibrater tool****
15-Apr-2026 14:47:38 2026-04-15 18:47:39        INFO        calibrater::open        Opening MS: ngc5921_put.ms for calibration.
15-Apr-2026 14:47:38 2026-04-15 18:47:39        INFO                Clearing all model records in MS header.
15-Apr-2026 14:47:38 2026-04-15 18:47:39        INFO        VisSetUtil::addScrCols        Adding MODEL_DATA and CORRECTED_DATA column(s).
15-Apr-2026 14:47:38 2026-04-15 18:47:39        INFO        VisSetUtil::initScrCols        Initializing MODEL_DATA to (unity).
15-Apr-2026 14:47:38 2026-04-15 18:47:39        INFO        VisSetUtil::initScrCols        Initialized 22653 rows.
15-Apr-2026 14:47:38 2026-04-15 18:47:39        INFO        Calibrater::        Initializing nominal selection to the whole MS.
15-Apr-2026 14:47:44 test_tool_ms.py::mstool_test_dataIO::test_getdata_putdata
15-Apr-2026 14:47:44 test ms.getdata, putdata
15-Apr-2026 14:47:44 PASSED
15-Apr-2026 14:47:44
15-Apr-2026 14:47:50 2026-04-15 18:47:50        INFO        ms::sort        Sorted main table of /home/casatest/casa6/casatestutils/nosedir/test_tool_ms/ngc5921.ms by  [ANTENNA1,ANTENNA2]  and stored it in ngc5921_sort.ms .
15-Apr-2026 14:47:50 test_tool_ms.py::mstool_test_sort::test_sort
15-Apr-2026 14:47:50 test ms.sort
15-Apr-2026 14:47:50 PASSED
15-Apr-2026 14:47:50
15-Apr-2026 14:47:51 2026-04-15 18:47:51        INFO        ms::timesort        Sorted main table of /home/casatest/casa6/casatestutils/nosedir/test_tool_ms/ngc5921.ms by TIME and stored it in ngc5921_timesort.ms .
15-Apr-2026 14:47:51 test_tool_ms.py::mstool_test_sort::test_timesort
15-Apr-2026 14:47:51 test ms.timesort
15-Apr-2026 14:47:51 PASSED
15-Apr-2026 14:47:51
15-Apr-2026 14:47:51 2026-04-15 18:47:52        INFO        SubMS::parseColumnNames()        Using DATA column.
15-Apr-2026 14:47:51 2026-04-15 18:47:52        INFO        Partition::makeSelection()        4509 out of 22653 rows are going to be considered due to the selection criteria.
15-Apr-2026 14:47:51 test_tool_ms.py::mstool_test_subms::test_partition
15-Apr-2026 14:47:51 test ms.partition
15-Apr-2026 14:47:51 PASSED
15-Apr-2026 14:47:51
15-Apr-2026 14:47:51 2026-04-15 18:47:52        INFO        SubMS::parseColumnNames()        Using DATA column.
15-Apr-2026 14:47:51 2026-04-15 18:47:52        INFO        SubMS::makeSelection()        4509 out of 22653 rows are going to be considered due to the selection criteria.
15-Apr-2026 14:47:52 2026-04-15 18:47:52        INFO        SubMS::fillDDTables()        The last output channel of spw 0 has only 3 input channels.
15-Apr-2026 14:47:52 2026-04-15 18:47:52        INFO        SubMS::doChannelMods()        Data binned.
15-Apr-2026 14:47:52 test_tool_ms.py::mstool_test_subms::test_split
15-Apr-2026 14:47:52 test ms.split
15-Apr-2026 14:47:52 PASSED
15-Apr-2026 14:47:52
15-Apr-2026 14:47:52 2026-04-15 18:47:52        INFO        SubMS::parseColumnNames()        Using DATA column.
15-Apr-2026 14:47:52 2026-04-15 18:47:53        INFO        SubMS::doTimeAver()        Data binned.
15-Apr-2026 14:47:53 test_tool_ms.py::mstool_test_subms::test_split_averaging
15-Apr-2026 14:47:53 test ms.split time averaging
15-Apr-2026 14:47:53 PASSED
15-Apr-2026 14:47:53
15-Apr-2026 14:47:53 test_tool_ms.py::mstool_test_iter::test_iteration_columns
15-Apr-2026 14:47:53 test ms.iter functions with sort columns
15-Apr-2026 14:47:53 PASSED
15-Apr-2026 14:47:53
15-Apr-2026 14:47:53 test_tool_ms.py::mstool_test_iter::test_iterinit_interval
15-Apr-2026 14:47:53 test ms.iterinit interval parameter
15-Apr-2026 14:47:53 PASSED
15-Apr-2026 14:47:53
15-Apr-2026 14:47:53 test_tool_ms.py::mstool_test_iter::test_iterinit_maxrows
15-Apr-2026 14:47:53 test ms.iterinit maxrows parameter
15-Apr-2026 14:47:53 PASSED
15-Apr-2026 14:47:53
15-Apr-2026 14:47:54 2026-04-15 18:47:54        INFO        MSFitsInput::MSFitsInput        Converting FITS file '/opt/casa/data/casatestdata/unittest/mstool/3c273.fits7' to MeasurementSet 'ngc4826.tutorial.3c273.7.ms'
15-Apr-2026 14:47:54 2026-04-15 18:47:54        INFO        MSFitsInput::setupMeasurementSet        Using tile shape [1, 64, 2048] for HATCREEK with obstype=0
15-Apr-2026 14:47:54 2026-04-15 18:47:54        INFO        MSFitsInput::fillMSMainTableColWise        SOURCE not found in UU VV WW BASELINE DATE
15-Apr-2026 14:47:54 2026-04-15 18:47:54        INFO        MSFitsInput::fillMSMainTableColWise        FREQSEL not found in UU VV WW BASELINE DATE
15-Apr-2026 14:47:54 2026-04-15 18:47:54        INFO        MSFitsInput::fillMSMainTableColWise        Reading and writing 2925 visibility groups
15-Apr-2026 14:47:54 2026-04-15 18:47:54        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS AN  nrows=12 ncols=12 rowsize=78 pcount=0 gcount=1
15-Apr-2026 14:47:54 2026-04-15 18:47:54        WARN        MSFitsInput::fillAntennaTable        XYZHAND keyword not found in AN table. Will assume antenna coordinate system is right handed.
15-Apr-2026 14:47:54 2026-04-15 18:47:54        INFO        MSFitsInput::fillExtraTables        Filling SOURCE table (this may take some time).
15-Apr-2026 14:47:54 2026-04-15 18:47:54        WARN        MSFitsInput::fillExtraTable        No systemic velocity for field 0
15-Apr-2026 14:47:54 2026-04-15 18:47:54        WARN        MSFitsInput::fillExtraTable        No rest frequency for field 0
15-Apr-2026 14:47:54 test_tool_ms.py::mstool_test_fits::test_badscan
15-Apr-2026 14:47:54 CAS-10054: Tests intermittent incorrect scan number in last row of single-scan dataset
15-Apr-2026 14:47:54 Last row has scan=1 ; (should be 1).
15-Apr-2026 14:47:54 PASSED
15-Apr-2026 14:47:54
15-Apr-2026 14:47:54 2026-04-15 18:47:54        INFO        MSFitsInput::MSFitsInput        Converting FITS file '/opt/casa/data/casatestdata/unittest/mstool/CTR_CHI_TR2.RWYCP-10rows-ANT-DIAMTER-0' to MeasurementSet 'CAS-5818.ms'
15-Apr-2026 14:47:54 2026-04-15 18:47:54        INFO        MSFitsInput::setupMeasurementSet        Using tile shape [4, 64, 512] for EVLA with obstype=0
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsInput::fillMSMainTable        Reading and writing 1 visibility groups
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS FQ  nrows=1 ncols=5 rowsize=204 pcount=0 gcount=1
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS AN  nrows=28 ncols=12 rowsize=62 pcount=0 gcount=1
15-Apr-2026 14:47:54 2026-04-15 18:47:55        WARN        MSFitsInput::fillAntennaTable        XYZHAND keyword not found in AN table. Will assume antenna coordinate system is right handed.
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS SU  nrows=1 ncols=19 rowsize=496 pcount=0 gcount=1
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsInput::fillExtraTables        Filling SOURCE table (this may take some time).
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        msmetadata_cmpt.cc::open        Performing internal consistency checks on CAS-5818.ms...
15-Apr-2026 14:47:54 test_tool_ms.py::mstool_test_fits::test_diameters
15-Apr-2026 14:47:54 CAS-5818: Verify bogus dish diameters in AN table are not used but normal algorithm is used instead
15-Apr-2026 14:47:54 PASSED
15-Apr-2026 14:47:54
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write         nchan=3 startchan=0 stepchan=1 avgchan=1
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write        Converting MeasurementSet /opt/casa/data/casatestdata/unittest/mstool/uvfits_test.ms to FITS file 'CAS-5492.uvfits'
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::_writeMain        CORRECTED_DATA does not exist, writing DATA
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::_writeMain        Frequency reference frame is LSRK
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write        Writing AIPS FQ table
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::writeFQ        Found 2 spectral windows
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write        Writing AIPS AN table
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::writeAN        Using ITRF frame for antenna positions.
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::writeAN        Found 8 antennas in array #1
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write         nchan=3 startchan=0 stepchan=1 avgchan=1
15-Apr-2026 14:47:54 2026-04-15 18:47:55        SEVERE        ms::tofits        Exception Reported: Exception: Error in output file : File CAS-5492.uvfits exists, and the user does not want to remove it..
15-Apr-2026 14:47:54 2026-04-15 18:47:55        SEVERE        ms::tofits+        ... thrown by void casacore::MSFitsOutput::write() const at File: /source/casa6/casatools/casacore/msfits/MSFits/MSFitsOutput.cc, line: 168
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write         nchan=3 startchan=0 stepchan=1 avgchan=1
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write        Removing existing file CAS-5492.uvfits
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write        Converting MeasurementSet /opt/casa/data/casatestdata/unittest/mstool/uvfits_test.ms to FITS file 'CAS-5492.uvfits'
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::_writeMain        CORRECTED_DATA does not exist, writing DATA
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::_writeMain        Frequency reference frame is LSRK
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write        Writing AIPS FQ table
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::writeFQ        Found 2 spectral windows
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::write        Writing AIPS AN table
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::writeAN        Using ITRF frame for antenna positions.
15-Apr-2026 14:47:54 2026-04-15 18:47:55        INFO        MSFitsOutput::writeAN        Found 8 antennas in array #1
15-Apr-2026 14:47:55 test_tool_ms.py::mstool_test_fits::test_export_overwrite
15-Apr-2026 14:47:55 CAS-5492: test the overwrite parameter when exporting MSes to uvfits
15-Apr-2026 14:47:55 PASSED
15-Apr-2026 14:47:55
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        MSFitsInput::MSFitsInput        Converting FITS file '/opt/casa/data/casatestdata/unittest/mstool/name10rows+000' to MeasurementSet 'CAS-7696.ms'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        MSFitsInput::setupMeasurementSet        Using tile shape [4, 64, 512] for EVLA with obstype=0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        MSFitsInput::fillMSMainTable        Reading and writing 1 visibility groups
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS FQ  nrows=1 ncols=5 rowsize=204 pcount=0 gcount=1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS AN  nrows=28 ncols=13 rowsize=66 pcount=0 gcount=1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS SU  nrows=1 ncols=19 rowsize=496 pcount=0 gcount=1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        MSFitsInput::fillExtraTables        Filling SOURCE table (this may take some time).
15-Apr-2026 14:47:55 test_tool_ms.py::mstool_test_fits::test_filename_extensions
15-Apr-2026 14:47:55 CAS-7696: Verify we turn off fits filename extension support when necessary
15-Apr-2026 14:47:55 PASSED
15-Apr-2026 14:47:55
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         read fitsfile=ngc5921.fits
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         Primary Group HDU ------>>>
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU         SIMPLE  =                      T /Standard FITS format
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        BITPIX  =                    -32 /Floating point values
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS   =                      7
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS1  =                      0 /Random groups, NOT image
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS2  =                      3
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS3  =                      2
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS4  =                     63
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS5  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS6  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS7  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        EXTEND  =                      T /Tables may follow
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        BLOCKED =                      T /File may be blocked
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        GROUPS  =                      T /Random Group UV data
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PCOUNT  =                      9 /Number of random parameters
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        GCOUNT  =                  22653 /Number of groups (rows) in the file
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        EPOCH   =                   2000
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        BSCALE  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        BZERO   =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        BUNIT   = 'UNCALIB '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CTYPE2  = 'COMPLEX '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRVAL2  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CDELT2  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRPIX2  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CROTA2  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CTYPE3  = 'STOKES  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRVAL3  =                     -1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CDELT3  =                     -1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRPIX3  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CROTA3  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CTYPE4  = 'FREQ    '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRVAL4  =            1.41342e+09
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CDELT4  =                24414.1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRPIX4  =                     32
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CROTA4  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CTYPE5  = 'IF      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRVAL5  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CDELT5  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRPIX5  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CROTA5  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CTYPE6  = 'RA      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRVAL6  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CDELT6  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRPIX6  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CROTA6  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CTYPE7  = 'DEC     '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRVAL7  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CDELT7  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CRPIX7  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        CROTA7  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PTYPE1  = 'UU      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PSCAL1  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PZERO1  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PTYPE2  = 'VV      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PSCAL2  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PZERO2  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PTYPE3  = 'WW      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PSCAL3  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PZERO3  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PTYPE4  = 'DATE    ' /Day number
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PSCAL4  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PZERO4  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PTYPE5  = 'DATE    ' /Day fraction
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PSCAL5  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PZERO5  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PTYPE6  = 'BASELINE'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PSCAL6  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PZERO6  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PTYPE7  = 'FREQSEL '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PSCAL7  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PZERO7  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PTYPE8  = 'SOURCE  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PSCAL8  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PZERO8  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PTYPE9  = 'INTTIM  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PSCAL9  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PZERO9  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        OBJECT  = 'MULTI   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        DATE-OBS= '1995-04-13T09:18:59.999771'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TELESCOP= 'VLA     '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        INSTRUME= 'VLA     '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        OBSERVER= 'TEST    '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        SORTORD = 'TB      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        SPECSYS = 'LSRK    '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        RESTFREQ=            1.42041e+09
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        HISTORY AIPS WTSCAL = 1.0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        ORIGIN  = 'casacore'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        END
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showPrimaryGroup         22653 groups total, display first 6 elements of the first 2 groups
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showPrimaryGroup +        Group 0 parms:  0 0 0 2.44982e+06 0.888194 257 1 1 30
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showPrimaryGroup +        Group 0 data:  2.45987 0 6 0.798322 0 6 21.1242 0 6 11.6481 0 6 39.7646 0 6 27.8526 0 6...
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showPrimaryGroup +        Group 1 parms:  -4.61236e-07 1.20458e-06 5.15788e-08 2.44982e+06 0.888194 258 1 1 30
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showPrimaryGroup +        Group 1 data:  0.00824685 -0.0166335 6 0.00102503 -0.00442628 6 -0.0403956 -0.32815 6 -0.179474 0.100313 6 -0.0678851 -0.773201 6 -0.358901 0.429815 6...
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         <<<------ Primary Group HDU
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         Binary Table HDU ------>>>
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU         XTENSION= 'BINTABLE' /Binary Table Extension
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        BITPIX  =                      8 /Character Information
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS   =                      2 /Two-dimensional table
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS1  =                     24 /Number of bytes per row
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS2  =                      1 /Number of rows
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PCOUNT  =                      0 /No random parameters
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        GCOUNT  =                      1 /Only one group
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFIELDS =                      5 /Number of columns
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        EXTNAME = 'AIPS FQ '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        EXTVER  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NO_IF   =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE1  = 'FRQSEL  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM1  = '1J      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE2  = 'IF FREQ '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM2  = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT2  = 'HZ      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE3  = 'CH WIDTH'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM3  = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT3  = 'HZ      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE4  = 'TOTAL BANDWIDTH'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM4  = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT4  = 'HZ      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE5  = 'SIDEBAND'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM5  = '1J      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        END
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable         1 rows, 5 cols, 24 bytes total
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable         the first 20 cols of the first 5 rows:
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable         0: | 1 | 0 | 24414.1 | 1.5502e+06 | 1 |
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         <<<------ Binary Table HDU
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         Binary Table HDU ------>>>
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU         XTENSION= 'BINTABLE' /Binary Table Extension
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        BITPIX  =                      8 /Character Information
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS   =                      2 /Two-dimensional table
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS1  =                     66 /Number of bytes per row
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS2  =                     28 /Number of rows
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PCOUNT  =                      0 /No random parameters
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        GCOUNT  =                      1 /Only one group
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFIELDS =                     13 /Number of columns
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        EXTNAME = 'AIPS AN '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        EXTVER  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        ARRAYX  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        ARRAYY  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        ARRAYZ  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        GSTIA0  =                200.712
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        DEGPDY  =                360.986
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        FREQ    =            1.41342e+09
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        RDATE   = '1995-04-13T09:18:59.999771'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        POLARX  =                2.12653
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        POLARY  =                17.1957
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        UT1UTC  =               0.123216
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        IATUTC  =                     29
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TIMSYS  = 'TAI     '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        ARRNAM  = 'VLA     '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NUMORB  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NOPCAL  =                      0
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        POLTYPE = '        '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        XYZHAND = 'RIGHT   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        FRAME   = 'ITRF    '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE1  = 'ANNAME  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM1  = '8A      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE2  = 'STABXYZ '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM2  = '3D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT2  = 'METERS  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE3  = 'ORBPARM '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM3  = '0D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE4  = 'NOSTA   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM4  = '1J      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE5  = 'MNTSTA  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM5  = '1J      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE6  = 'STAXOF  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM6  = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT6  = 'METERS  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE7  = 'POLTYA  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM7  = '1A      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE8  = 'POLAA   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM8  = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT8  = 'DEGREES '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE9  = 'POLCALA '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM9  = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE10 = 'POLTYB  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM10 = '1A      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE11 = 'POLAB   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM11 = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT11 = 'DEGREES '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE12 = 'POLCALB '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM12 = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE13 = 'DIAMETER'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM13 = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        END
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable         28 rows, 13 cols, 1848 bytes total
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable         the first 20 cols of the first 5 rows:
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable         0: | VLA:N7 | -1.60116e+06, -5.04178e+06, 3.55516e+06 | | 1 | 0 | 0.00164886 | R | 0 | 0 | L | 0 | 0 | 25 |
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable +        1: | VLA:W1 | -1.60119e+06, -5.042e+06, 3.55484e+06 | | 2 | 0 | 0.000869398 | R | 0 | 0 | L | 0 | 0 | 25 |
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable +        2: | VLA:W2 | -1.60123e+06, -5.04198e+06, 3.55486e+06 | | 3 | 0 | -0.00116919 | R | 0 | 0 | L | 0 | 0 | 25 |
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable +        3: | VLA:E1 | -1.60119e+06, -5.04202e+06, 3.55481e+06 | | 4 | 0 | 0.0093835 | R | 0 | 0 | L | 0 | 0 | 25 |
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable +        4: | VLA:E3 | -1.60111e+06, -5.04202e+06, 3.55484e+06 | | 5 | 0 | 0.000869398 | R | 0 | 0 | L | 0 | 0 | 25 |
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         <<<------ Binary Table HDU
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         Binary Table HDU ------>>>
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU         XTENSION= 'BINTABLE' /Binary Table Extension
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        BITPIX  =                      8 /Character Information
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS   =                      2 /Two-dimensional table
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS1  =                    136 /Number of bytes per row
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NAXIS2  =                      3 /Number of rows
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        PCOUNT  =                      0 /No random parameters
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        GCOUNT  =                      1 /Only one group
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFIELDS =                     19 /Number of columns
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        EXTNAME = 'AIPS SU '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        EXTVER  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        NO_IF   =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        FREQID  =                      1
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE1  = 'ID. NO. '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM1  = '1J      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE2  = 'SOURCE  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM2  = '20A     '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE3  = 'QUAL    '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM3  = '1J      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE4  = 'CALCODE '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM4  = '4A      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE5  = 'IFLUX   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM5  = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT5  = 'JY      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE6  = 'QFLUX   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM6  = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT6  = 'JY      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE7  = 'UFLUX   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM7  = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT7  = 'JY      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE8  = 'VFLUX   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM8  = '1E      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT8  = 'JY      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE9  = 'FREQOFF '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM9  = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT9  = 'HZ      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE10 = 'BANDWIDTH'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM10 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT10 = 'HZ      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE11 = 'RAEPO   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM11 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT11 = 'DEGREES '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE12 = 'DECEPO  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM12 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT12 = 'DEGREES '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE13 = 'EPOCH   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM13 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT13 = 'YEARS   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE14 = 'RAAPP   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM14 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT14 = 'DEGREES '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE15 = 'DECAPP  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM15 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT15 = 'DEGREES '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE16 = 'LSRVEL  '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM16 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT16 = 'M/SEC   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE17 = 'RESTFREQ'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM17 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT17 = 'HZ      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE18 = 'PMRA    '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM18 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT18 = 'DEG/DAY '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TTYPE19 = 'PMDEC   '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TFORM19 = '1D      '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        TUNIT19 = 'DEG/DAY '
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +               
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showHDU +        END
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable         3 rows, 19 cols, 408 bytes total
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable         the first 20 cols of the first 5 rows:
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable         0: | 1 | 1331+30500002_0      | 0 |      | 0 | 0 | 0 | 0 | 0 | 1.5502e+06 | -157.215 | 30.5092 | 2000 | -157.263 | 30.5314 | 0 | 1.42041e+09 | 0 | 0 |
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable +        1: | 2 | 1445+09900002_0      | 0 |      | 0 | 0 | 0 | 0 | 0 | 1.5502e+06 | -138.681 | 9.97669 | 2000 | -138.732 | 9.99458 | 0 | 1.42041e+09 | 0 | 0 |
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::showBinaryTable +        2: | 3 | N5921_2              | 0 |      | 0 | 0 | 0 | 0 | 0 | 1.5502e+06 | -129.5 | 5.06667 | 2000 | -129.552 | 5.08192 | 0 | 1.42041e+09 | 0 | 0 |
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         <<<------ Binary Table HDU
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        FITSReader::listFits         finish processing of Header-Data Units.
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        MSFitsInput::MSFitsInput        Converting FITS file 'ngc5921.fits' to MeasurementSet 'fromfits.ms'
15-Apr-2026 14:47:55 2026-04-15 18:47:55        INFO        MSFitsInput::setupMeasurementSet        Using tile shape [2, 63, 1040] for VLA with obstype=0
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsInput::fillMSMainTable        Reading and writing 22653 visibility groups
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS FQ  nrows=1 ncols=5 rowsize=24 pcount=0 gcount=1
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS AN  nrows=28 ncols=13 rowsize=66 pcount=0 gcount=1
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS SU  nrows=3 ncols=19 rowsize=136 pcount=0 gcount=1
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsInput::fillExtraTables        Filling SOURCE table (this may take some time).
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        ms::tofits        By selection 22653 rows to be converted are reduced to 4509
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::write         nchan=63 startchan=0 stepchan=1 avgchan=1
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::write        Converting MeasurementSet /home/casatest/casa6/casatestutils/nosedir/test_tool_ms/tab1452_1123 to FITS file 'testfile.fits'
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::_writeMain        Writing DATA column
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::_writeMain        Frequency reference frame is LSRK
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::write        Writing AIPS FQ table
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::writeFQ        Found 1 spectral windows
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::write        Writing AIPS AN table
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::writeAN        Using ITRF frame for antenna positions.
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::writeAN        Found 28 antennas in array #1
15-Apr-2026 14:47:55 test_tool_ms.py::mstool_test_fits::test_list_from_tofits
15-Apr-2026 14:47:55 test ms.listfits, fromfits, tofits
15-Apr-2026 14:47:55 PASSED
15-Apr-2026 14:47:55
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::write         nchan=3 startchan=0 stepchan=1 avgchan=1
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::write        Converting MeasurementSet /opt/casa/data/casatestdata/unittest/mstool/uvfits_test.ms to FITS file 'xyz.uvfits'
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::_writeMain        CORRECTED_DATA does not exist, writing DATA
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::_writeMain        Frequency reference frame is LSRK
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::write        Writing AIPS FQ table
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::writeFQ        Found 2 spectral windows
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::write        Writing AIPS AN table
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::writeAN        Using ITRF frame for antenna positions.
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsOutput::writeAN        Found 8 antennas in array #1
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsInput::MSFitsInput        Converting FITS file 'xyz.uvfits' to MeasurementSet 'ke.ms'
15-Apr-2026 14:47:55 2026-04-15 18:47:56        INFO        MSFitsInput::setupMeasurementSet        Using tile shape [1, 3, 43690] for SMA with obstype=0
15-Apr-2026 14:47:56 2026-04-15 18:47:56        INFO        MSFitsInput::fillMSMainTableColWise        SOURCE not found in UU VV WW DATE DATE BASELINE FREQSEL
15-Apr-2026 14:47:56 2026-04-15 18:47:56        INFO        MSFitsInput::fillMSMainTableColWise        Reading and writing 630 visibility groups
15-Apr-2026 14:47:56 2026-04-15 18:47:56        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS FQ  nrows=2 ncols=5 rowsize=24 pcount=0 gcount=1
15-Apr-2026 14:47:56 2026-04-15 18:47:56        INFO        MSFitsInput::readRandomGroupUVFits        extname=AIPS AN  nrows=8 ncols=13 rowsize=66 pcount=0 gcount=1
15-Apr-2026 14:47:56 2026-04-15 18:47:56        INFO        MSFitsInput::fillExtraTables        Filling SOURCE table (this may take some time).
15-Apr-2026 14:47:56 2026-04-15 18:47:56        WARN        MSFitsInput::fillExtraTable        No systemic velocity for field 0
15-Apr-2026 14:47:56 2026-04-15 18:47:56        WARN        MSFitsInput::fillExtraTable        No rest frequency for field 0
15-Apr-2026 14:47:56 2026-04-15 18:47:56        WARN        MSFitsInput::fillExtraTable        No systemic velocity for field 0
15-Apr-2026 14:47:56 2026-04-15 18:47:56        WARN        MSFitsInput::fillExtraTable        No rest frequency for field 0
15-Apr-2026 14:47:56 test_tool_ms.py::mstool_test_fits::test_receptor_angle
15-Apr-2026 14:47:56 CAS-7081: Test receptor angle is preserved
15-Apr-2026 14:47:56 PASSED
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 2026-04-15 18:47:56        INFO        MSFitsInput::MSFitsInput        Converting FITS file '/opt/casa/data/casatestdata/unittest/mstool/1331+305_I.UVFITS' to MeasurementSet 'my.ms'
15-Apr-2026 14:47:56 2026-04-15 18:47:56        SEVERE        ms::fromfits        Stokes I cannot be decomposed into proper correlation types without making assumptions. This functionality is not supported at File: /source/casa6/casatools/casacore/msfits/MSFits/MSFitsInput.cc, line: 744 at File: /source/casa6/casatools/casacore/msfits/MSFits/MSFitsInput.cc, line: 597
15-Apr-2026 14:47:56 test_tool_ms.py::mstool_test_fits::test_stokes
15-Apr-2026 14:47:56 Verify fix to CAS_4283, uvfits files containing actual Stokes parameters will not be imported
15-Apr-2026 14:47:56 PASSED
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 - generated xml file: /home/casatest/casa6/casatestutils/nosedir/xml/test_tool_ms/nose.xml -
15-Apr-2026 14:47:56 ======================== 53 passed, 1 warning in 36.50s ========================
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_subimage/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_subimage
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_image_subimage/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_image_subimage/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_calibrater/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_calibrater
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_calibrater/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_calibrater/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_rebin/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_rebin
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_image_rebin/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_image_rebin/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_measures/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_measures
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_measures/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_measures/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_ms_createmultims/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_ms_createmultims
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_ms_createmultims/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_ms_createmultims/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_image/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_image/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_sdm/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_sdm
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_sdm/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_sdm/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_table/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_table
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_table/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_table/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_logsink/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_logsink
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_logsink/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_logsink/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_sdm_toms/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_sdm_toms
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_sdm_toms/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_sdm_toms/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_transpose/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_transpose
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_image_transpose/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_image_transpose/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_synthesisutils/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_synthesisutils
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_synthesisutils/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_synthesisutils/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_regrid/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_regrid
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_image_regrid/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_image_regrid/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_deviation/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_deviation
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_image_deviation/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_image_deviation/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_statistics/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_statistics
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_image_statistics/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_image_statistics/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_pbcor/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_image_pbcor
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_image_pbcor/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_image_pbcor/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_vpmanager/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_vpmanager
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_vpmanager/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_vpmanager/
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Setting Working Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_ms/
15-Apr-2026 14:47:56 Test Directory: /home/casatest/casa6/casatestutils/nosedir/test_tool_ms
15-Apr-2026 14:47:56
15-Apr-2026 14:47:56 Running Command: pytest --junitxml=/home/casatest/casa6/casatestutils/nosedir/xml/test_tool_ms/nose.xml -s --disable-pytest-warnings --verbose -ra --tb=short /home/casatest/casa6/casatestutils/nosedir/test_tool_ms/
15-Apr-2026 14:47:59 total 77448
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci 15001   160658 Apr 15 18:28 casatestutils-6.7.5.16-py3-none-any.whl
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci 15001 78972047 Apr 15 18:28 casatools-6.7.5.16-cp312-cp312-manylinux_2_28_x86_64.whl
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      4340 Apr 15 18:47 test_tool_agentflagger.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1006 Apr 15 18:47 test_tool_calanalysis.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      2658 Apr 15 18:47 test_tool_calibrater.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       687 Apr 15 18:47 test_tool_componentlist.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      7467 Apr 15 18:47 test_tool_coordsys.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root     12935 Apr 15 18:47 test_tool_image.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      2220 Apr 15 18:47 test_tool_image_collapse.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1048 Apr 15 18:47 test_tool_image_deviation.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      2575 Apr 15 18:47 test_tool_image_fitprofile.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1178 Apr 15 18:47 test_tool_image_pbcor.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       883 Apr 15 18:47 test_tool_image_pv.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1006 Apr 15 18:47 test_tool_image_rebin.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1336 Apr 15 18:47 test_tool_image_regrid.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1641 Apr 15 18:47 test_tool_image_statistics.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       765 Apr 15 18:47 test_tool_image_subimage.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       890 Apr 15 18:47 test_tool_image_transpose.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1966 Apr 15 18:47 test_tool_imagepol.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       839 Apr 15 18:47 test_tool_linearmosaic.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       669 Apr 15 18:47 test_tool_logsink.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       549 Apr 15 18:47 test_tool_measures.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      5224 Apr 15 18:47 test_tool_ms.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       368 Apr 15 18:47 test_tool_ms_createmultims.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      2095 Apr 15 18:47 test_tool_ms_statwt.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      8633 Apr 15 18:47 test_tool_msmetadata.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       359 Apr 15 18:47 test_tool_msuvbinner.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1171 Apr 15 18:47 test_tool_quanta.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      3977 Apr 15 18:47 test_tool_regionmanager.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      2072 Apr 15 18:47 test_tool_sdm.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      2096 Apr 15 18:47 test_tool_sdm_toms.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root       670 Apr 15 18:47 test_tool_simulator.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1717 Apr 15 18:47 test_tool_synthesisutils.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1462 Apr 15 18:47 test_tool_table.xml
15-Apr-2026 14:47:59 -rw-r--r-- 1 casaci root      1717 Apr 15 18:47 test_tool_vpmanager.xml
15-Apr-2026 14:47:59 Finished task 'Test wheel' with result: Success
15-Apr-2026 14:47:59 Starting task 'Tar work directory' of type 'com.atlassian.bamboo.plugins.scripttask:task.builder.script'
15-Apr-2026 14:47:59
Beginning to execute external process for build 'CASASPECS - Master Test 3.12 - Test Tools Many Linux 2.28 Rocky 8.10 Py3.12 #257 (CASASPECS-MASTERTESTPY312-TTOMLPY38-257)'
... running command line:
/export/home/cbt-el7-1/bamboo-home/temp/CASASPECS-MASTERTESTPY312-TTOMLPY38-257-ScriptBuildTask-11209996589855725618.sh
... in: /export/home/cbt-el7-1/bamboo-home/xml-data/build-dir/CASASPECS-MASTERTESTPY312-TTOMLPY38
15-Apr-2026 14:48:00 Package working directory
15-Apr-2026 14:48:00 tar: nosedir: Cannot stat: No such file or directory
15-Apr-2026 14:48:00 tar: Exiting with failure status due to previous errors
15-Apr-2026 14:48:00 total 77452
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci 15001   160658 Apr 15 18:28 casatestutils-6.7.5.16-py3-none-any.whl
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci 15001 78972047 Apr 15 18:28 casatools-6.7.5.16-cp312-cp312-manylinux_2_28_x86_64.whl
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      4340 Apr 15 18:47 test_tool_agentflagger.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1006 Apr 15 18:47 test_tool_calanalysis.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      2658 Apr 15 18:47 test_tool_calibrater.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       687 Apr 15 18:47 test_tool_componentlist.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      7467 Apr 15 18:47 test_tool_coordsys.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root     12935 Apr 15 18:47 test_tool_image.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      2220 Apr 15 18:47 test_tool_image_collapse.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1048 Apr 15 18:47 test_tool_image_deviation.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      2575 Apr 15 18:47 test_tool_image_fitprofile.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1178 Apr 15 18:47 test_tool_image_pbcor.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       883 Apr 15 18:47 test_tool_image_pv.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1006 Apr 15 18:47 test_tool_image_rebin.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1336 Apr 15 18:47 test_tool_image_regrid.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1641 Apr 15 18:47 test_tool_image_statistics.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       765 Apr 15 18:47 test_tool_image_subimage.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       890 Apr 15 18:47 test_tool_image_transpose.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1966 Apr 15 18:47 test_tool_imagepol.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       839 Apr 15 18:47 test_tool_linearmosaic.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       669 Apr 15 18:47 test_tool_logsink.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       549 Apr 15 18:47 test_tool_measures.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      5224 Apr 15 18:47 test_tool_ms.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       368 Apr 15 18:47 test_tool_ms_createmultims.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      2095 Apr 15 18:47 test_tool_ms_statwt.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      8633 Apr 15 18:47 test_tool_msmetadata.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       359 Apr 15 18:47 test_tool_msuvbinner.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1171 Apr 15 18:47 test_tool_quanta.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      3977 Apr 15 18:47 test_tool_regionmanager.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      2072 Apr 15 18:47 test_tool_sdm.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      2096 Apr 15 18:47 test_tool_sdm_toms.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root       670 Apr 15 18:47 test_tool_simulator.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1717 Apr 15 18:47 test_tool_synthesisutils.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1462 Apr 15 18:47 test_tool_table.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root      1717 Apr 15 18:47 test_tool_vpmanager.xml
15-Apr-2026 14:48:00 -rw-r--r-- 1 casaci root        45 Apr 15 18:48 work-manylinux228-3.12.tar.gz
15-Apr-2026 14:48:00 Done packaging working directory
15-Apr-2026 14:48:00 Finished task 'Tar work directory' with result: Success
15-Apr-2026 14:48:00 Starting task 'Parse tests' of type 'com.atlassian.bamboo.plugins.testresultparser:task.testresultparser.junit'
15-Apr-2026 14:48:00 Parsing test results under /export/home/cbt-el7-1/bamboo-home/xml-data/build-dir/CASASPECS-MASTERTESTPY312-TTOMLPY38...
15-Apr-2026 14:48:00 Finished task 'Parse tests' with result: Success
15-Apr-2026 14:48:00 Starting task 'Upload wheel' of type 'com.atlassian.bamboo.plugins.scripttask:task.builder.script'
15-Apr-2026 14:48:00
Beginning to execute external process for build 'CASASPECS - Master Test 3.12 - Test Tools Many Linux 2.28 Rocky 8.10 Py3.12 #257 (CASASPECS-MASTERTESTPY312-TTOMLPY38-257)'
... running command line:
/export/home/cbt-el7-1/bamboo-home/temp/CASASPECS-MASTERTESTPY312-TTOMLPY38-257-ScriptBuildTask-7581266749557431306.sh
... in: /export/home/cbt-el7-1/bamboo-home/xml-data/build-dir/CASASPECS-MASTERTESTPY312-TTOMLPY38
15-Apr-2026 14:48:03 Collecting twine
15-Apr-2026 14:48:03   Downloading twine-6.2.0-py3-none-any.whl (42 kB)
15-Apr-2026 14:48:03      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 42.7/42.7 kB 1.8 MB/s eta 0:00:00
15-Apr-2026 14:48:03 Collecting requests-toolbelt!=0.9.0,>=0.8.0
15-Apr-2026 14:48:03   Downloading requests_toolbelt-1.0.0-py2.py3-none-any.whl (54 kB)
15-Apr-2026 14:48:03      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 54.5/54.5 kB 8.0 MB/s eta 0:00:00
15-Apr-2026 14:48:03 Collecting rfc3986>=1.4.0
15-Apr-2026 14:48:03   Downloading rfc3986-2.0.0-py2.py3-none-any.whl (31 kB)
15-Apr-2026 14:48:04 Collecting rich>=12.0.0
15-Apr-2026 14:48:04   Downloading rich-15.0.0-py3-none-any.whl (310 kB)
15-Apr-2026 14:48:04      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 310.7/310.7 kB 16.2 MB/s eta 0:00:00
15-Apr-2026 14:48:04 Collecting readme-renderer>=35.0
15-Apr-2026 14:48:04   Downloading readme_renderer-44.0-py3-none-any.whl (13 kB)
15-Apr-2026 14:48:04 Collecting requests>=2.20
15-Apr-2026 14:48:04   Downloading requests-2.33.1-py3-none-any.whl (64 kB)
15-Apr-2026 14:48:04      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 64.9/64.9 kB 13.3 MB/s eta 0:00:00
15-Apr-2026 14:48:04 Collecting packaging>=24.0
15-Apr-2026 14:48:04   Downloading packaging-26.1-py3-none-any.whl (95 kB)
15-Apr-2026 14:48:04      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 95.8/95.8 kB 12.8 MB/s eta 0:00:00
15-Apr-2026 14:48:04 Collecting keyring>=21.2.0
15-Apr-2026 14:48:04   Downloading keyring-25.7.0-py3-none-any.whl (39 kB)
15-Apr-2026 14:48:04 Collecting id
15-Apr-2026 14:48:04   Downloading id-1.6.1-py3-none-any.whl (14 kB)
15-Apr-2026 14:48:04 Collecting urllib3>=1.26.0
15-Apr-2026 14:48:04   Downloading urllib3-2.6.3-py3-none-any.whl (131 kB)
15-Apr-2026 14:48:04      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 131.6/131.6 kB 16.0 MB/s eta 0:00:00
15-Apr-2026 14:48:04 Collecting jaraco.classes
15-Apr-2026 14:48:04   Downloading jaraco.classes-3.4.0-py3-none-any.whl (6.8 kB)
15-Apr-2026 14:48:04 Collecting importlib_metadata>=4.11.4
15-Apr-2026 14:48:04   Downloading importlib_metadata-9.0.0-py3-none-any.whl (27 kB)
15-Apr-2026 14:48:04 Collecting SecretStorage>=3.2
15-Apr-2026 14:48:04   Downloading secretstorage-3.5.0-py3-none-any.whl (15 kB)
15-Apr-2026 14:48:04 Collecting jaraco.context
15-Apr-2026 14:48:04   Downloading jaraco_context-6.1.2-py3-none-any.whl (7.9 kB)
15-Apr-2026 14:48:04 Collecting jeepney>=0.4.2
15-Apr-2026 14:48:04   Downloading jeepney-0.9.0-py3-none-any.whl (49 kB)
15-Apr-2026 14:48:04      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 49.0/49.0 kB 11.2 MB/s eta 0:00:00
15-Apr-2026 14:48:04 Collecting jaraco.functools
15-Apr-2026 14:48:04   Downloading jaraco_functools-4.4.0-py3-none-any.whl (10 kB)
15-Apr-2026 14:48:04 Collecting Pygments>=2.5.1
15-Apr-2026 14:48:04   Downloading pygments-2.20.0-py3-none-any.whl (1.2 MB)
15-Apr-2026 14:48:05      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 1.2/1.2 MB 24.7 MB/s eta 0:00:00
15-Apr-2026 14:48:05 Collecting nh3>=0.2.14
15-Apr-2026 14:48:05   Downloading nh3-0.3.4-cp38-abi3-manylinux_2_17_x86_64.manylinux2014_x86_64.whl (804 kB)
15-Apr-2026 14:48:05      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 805.0/805.0 kB 35.4 MB/s eta 0:00:00
15-Apr-2026 14:48:05 Collecting docutils>=0.21.2
15-Apr-2026 14:48:05   Downloading docutils-0.22.4-py3-none-any.whl (633 kB)
15-Apr-2026 14:48:05      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 633.2/633.2 kB 39.1 MB/s eta 0:00:00
15-Apr-2026 14:48:05 Collecting charset_normalizer<4,>=2
15-Apr-2026 14:48:05   Downloading charset_normalizer-3.4.7-cp310-cp310-manylinux2014_x86_64.manylinux_2_17_x86_64.manylinux_2_28_x86_64.whl (216 kB)
15-Apr-2026 14:48:05      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 216.9/216.9 kB 34.2 MB/s eta 0:00:00
15-Apr-2026 14:48:05 Collecting certifi>=2023.5.7
15-Apr-2026 14:48:05   Downloading certifi-2026.2.25-py3-none-any.whl (153 kB)
15-Apr-2026 14:48:05      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 153.7/153.7 kB 31.0 MB/s eta 0:00:00
15-Apr-2026 14:48:05 Collecting idna<4,>=2.5
15-Apr-2026 14:48:05   Downloading idna-3.11-py3-none-any.whl (71 kB)
15-Apr-2026 14:48:05      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 71.0/71.0 kB 16.7 MB/s eta 0:00:00
15-Apr-2026 14:48:05 Collecting markdown-it-py>=2.2.0
15-Apr-2026 14:48:05   Downloading markdown_it_py-4.0.0-py3-none-any.whl (87 kB)
15-Apr-2026 14:48:05      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 87.3/87.3 kB 17.3 MB/s eta 0:00:00
15-Apr-2026 14:48:06 Collecting zipp>=3.20
15-Apr-2026 14:48:06   Downloading zipp-3.23.1-py3-none-any.whl (10 kB)
15-Apr-2026 14:48:06 Collecting mdurl~=0.1
15-Apr-2026 14:48:06   Downloading mdurl-0.1.2-py3-none-any.whl (10.0 kB)
15-Apr-2026 14:48:06 Collecting cryptography>=2.0
15-Apr-2026 14:48:06   Downloading cryptography-46.0.7-cp38-abi3-manylinux_2_28_x86_64.whl (4.5 MB)
15-Apr-2026 14:48:06      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 4.5/4.5 MB 52.9 MB/s eta 0:00:00
15-Apr-2026 14:48:07 Collecting more-itertools
15-Apr-2026 14:48:07   Downloading more_itertools-11.0.2-py3-none-any.whl (71 kB)
15-Apr-2026 14:48:07      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 71.9/71.9 kB 10.0 MB/s eta 0:00:00
15-Apr-2026 14:48:07 Collecting backports.tarfile
15-Apr-2026 14:48:07   Downloading backports.tarfile-1.2.0-py3-none-any.whl (30 kB)
15-Apr-2026 14:48:07 Collecting typing-extensions>=4.13.2
15-Apr-2026 14:48:07   Downloading typing_extensions-4.15.0-py3-none-any.whl (44 kB)
15-Apr-2026 14:48:07      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 44.6/44.6 kB 6.2 MB/s eta 0:00:00
15-Apr-2026 14:48:07 Collecting cffi>=2.0.0
15-Apr-2026 14:48:07   Downloading cffi-2.0.0-cp310-cp310-manylinux2014_x86_64.manylinux_2_17_x86_64.whl (216 kB)
15-Apr-2026 14:48:07      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 216.5/216.5 kB 35.4 MB/s eta 0:00:00
15-Apr-2026 14:48:07 Collecting pycparser
15-Apr-2026 14:48:07   Downloading pycparser-3.0-py3-none-any.whl (48 kB)
15-Apr-2026 14:48:07      ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 48.2/48.2 kB 7.0 MB/s eta 0:00:00
15-Apr-2026 14:48:08 Installing collected packages: zipp, urllib3, typing-extensions, rfc3986, Pygments, pycparser, packaging, nh3, more-itertools, mdurl, jeepney, idna, docutils, charset_normalizer, certifi, backports.tarfile, requests, readme-renderer, markdown-it-py, jaraco.functools, jaraco.context, jaraco.classes, importlib_metadata, id, cffi, rich, requests-toolbelt, cryptography, SecretStorage, keyring, twine
15-Apr-2026 14:48:11 WARNING: Running pip as the 'root' user can result in broken permissions and conflicting behaviour with the system package manager. It is recommended to use a virtual environment instead: https://pip.pypa.io/warnings/venv
15-Apr-2026 14:48:11 Successfully installed Pygments-2.20.0 SecretStorage-3.5.0 backports.tarfile-1.2.0 certifi-2026.2.25 cffi-2.0.0 charset_normalizer-3.4.7 cryptography-46.0.7 docutils-0.22.4 id-1.6.1 idna-3.11 importlib_metadata-9.0.0 jaraco.classes-3.4.0 jaraco.context-6.1.2 jaraco.functools-4.4.0 jeepney-0.9.0 keyring-25.7.0 markdown-it-py-4.0.0 mdurl-0.1.2 more-itertools-11.0.2 nh3-0.3.4 packaging-26.1 pycparser-3.0 readme-renderer-44.0 requests-2.33.1 requests-toolbelt-1.0.0 rfc3986-2.0.0 rich-15.0.0 twine-6.2.0 typing-extensions-4.15.0 urllib3-2.6.3 zipp-3.23.1
15-Apr-2026 14:48:11
15-Apr-2026 14:48:11 [notice] A new release of pip is available: 23.0.1 -> 26.0.1
15-Apr-2026 14:48:11 [notice] To update, run: pip3 install --upgrade pip
15-Apr-2026 14:48:11 Cloning into 'casa-build-utils'...
15-Apr-2026 14:48:13 Uploading distributions to
15-Apr-2026 14:48:13 https://casa-pip.nrao.edu:443/repository/casa-test-wheel/
15-Apr-2026 14:48:14 Uploading casatools-6.7.5.16-cp312-cp312-manylinux_2_28_x86_64.whl
15-Apr-2026 14:48:14
15-Apr-2026 14:48:14   0% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 0.0/79.0 MB--:--?
15-Apr-2026 14:48:14   7% ━━╸━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 5.6/79.0 MB00:0179.6 MB/s
15-Apr-2026 14:48:14 12% ━━━━╸━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 9.1/79.0 MB00:0172.2 MB/s
15-Apr-2026 14:48:14 14% ━━━━━╸━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 10.9/79.0 MB00:0246.5 MB/s
15-Apr-2026 14:48:14 16% ━━━━━━╸━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 12.9/79.0 MB00:0239.3 MB/s
15-Apr-2026 14:48:14 19% ━━━━━━━╸━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 14.9/79.0 MB00:0235.9 MB/s
15-Apr-2026 14:48:14 22% ━━━━━━━━╸━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 17.5/79.0 MB00:0327.5 MB/s
15-Apr-2026 14:48:14 24% ━━━━━━━━━╸━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 19.2/79.0 MB00:0327.1 MB/s
15-Apr-2026 14:48:15 27% ━━━━━━━━━━╸━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 21.3/79.0 MB00:0323.5 MB/s
15-Apr-2026 14:48:15 30% ━━━━━━━━━━━━╺━━━━━━━━━━━━━━━━━━━━━━━━━━━ 24.0/79.0 MB00:0320.0 MB/s
15-Apr-2026 14:48:15 33% ━━━━━━━━━━━━━╺━━━━━━━━━━━━━━━━━━━━━━━━━━ 25.9/79.0 MB00:0320.1 MB/s
15-Apr-2026 14:48:15 36% ━━━━━━━━━━━━━━╺━━━━━━━━━━━━━━━━━━━━━━━━━ 28.2/79.0 MB00:0320.0 MB/s
15-Apr-2026 14:48:15 39% ━━━━━━━━━━━━━━━╸━━━━━━━━━━━━━━━━━━━━━━━━ 30.9/79.0 MB00:0319.9 MB/s
15-Apr-2026 14:48:15 43% ━━━━━━━━━━━━━━━━━╺━━━━━━━━━━━━━━━━━━━━━━ 34.0/79.0 MB00:0222.9 MB/s
15-Apr-2026 14:48:15 46% ━━━━━━━━━━━━━━━━━━╺━━━━━━━━━━━━━━━━━━━━━ 36.0/79.0 MB00:0223.6 MB/s
15-Apr-2026 14:48:15 48% ━━━━━━━━━━━━━━━━━━━╺━━━━━━━━━━━━━━━━━━━━ 38.0/79.0 MB00:0224.0 MB/s
15-Apr-2026 14:48:15 51% ━━━━━━━━━━━━━━━━━━━━╺━━━━━━━━━━━━━━━━━━━ 40.1/79.0 MB00:0223.6 MB/s
15-Apr-2026 14:48:15 54% ━━━━━━━━━━━━━━━━━━━━━╺━━━━━━━━━━━━━━━━━━ 42.4/79.0 MB00:0222.6 MB/s
15-Apr-2026 14:48:16 56% ━━━━━━━━━━━━━━━━━━━━━━╺━━━━━━━━━━━━━━━━━ 44.3/79.0 MB00:0222.1 MB/s
15-Apr-2026 14:48:16 59% ━━━━━━━━━━━━━━━━━━━━━━━╸━━━━━━━━━━━━━━━━ 47.0/79.0 MB00:0222.2 MB/s
15-Apr-2026 14:48:16 64% ━━━━━━━━━━━━━━━━━━━━━━━━━╺━━━━━━━━━━━━━━ 50.2/79.0 MB00:0222.1 MB/s
15-Apr-2026 14:48:16 66% ━━━━━━━━━━━━━━━━━━━━━━━━━━╸━━━━━━━━━━━━━ 52.3/79.0 MB00:0222.4 MB/s
15-Apr-2026 14:48:16 69% ━━━━━━━━━━━━━━━━━━━━━━━━━━━╸━━━━━━━━━━━━ 54.4/79.0 MB00:0223.3 MB/s
15-Apr-2026 14:48:16 72% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━╸━━━━━━━━━━━ 56.5/79.0 MB00:0123.1 MB/s
15-Apr-2026 14:48:16 74% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━╸━━━━━━━━━━ 58.5/79.0 MB00:0123.4 MB/s
15-Apr-2026 14:48:16 77% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━╸━━━━━━━━━ 60.6/79.0 MB00:0123.8 MB/s
15-Apr-2026 14:48:16 80% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━╺━━━━━━━ 63.2/79.0 MB00:0122.2 MB/s
15-Apr-2026 14:48:17 84% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━╸━━━━━━ 66.6/79.0 MB00:0124.0 MB/s
15-Apr-2026 14:48:17 87% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━╸━━━━━ 68.8/79.0 MB00:0125.4 MB/s
15-Apr-2026 14:48:17 90% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━╸━━━━ 70.9/79.0 MB00:0125.3 MB/s
15-Apr-2026 14:48:17 93% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━╺━━ 73.7/79.0 MB00:0125.4 MB/s
15-Apr-2026 14:48:17 96% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━╺━ 75.8/79.0 MB00:0125.2 MB/s
15-Apr-2026 14:48:17 99% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━╺ 77.8/79.0 MB00:0125.1 MB/s
15-Apr-2026 14:48:17 100% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 79.0/79.0 MB00:0322.5 MB/s
15-Apr-2026 14:48:17 100% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 79.0/79.0 MB00:0322.5 MB/s
15-Apr-2026 14:48:17 100% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 79.0/79.0 MB00:0322.5 MB/s
15-Apr-2026 14:48:17 100% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 79.0/79.0 MB00:0322.5 MB/s
15-Apr-2026 14:48:18 Uploading distributions to
15-Apr-2026 14:48:18 https://casa-pip.nrao.edu:443/repository/casa-test-wheel/
15-Apr-2026 14:48:18 Uploading casatestutils-6.7.5.16-py3-none-any.whl
15-Apr-2026 14:48:18
15-Apr-2026 14:48:18   0% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 0.0/174.0 kB--:--?
15-Apr-2026 14:48:18 100% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 174.0/174.0 kB00:0056.6 MB/s
15-Apr-2026 14:48:18 100% ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 174.0/174.0 kB00:0056.6 MB/s
15-Apr-2026 14:48:18
15-Apr-2026 14:48:18 Finished task 'Upload wheel' with result: Success
15-Apr-2026 14:48:18 Starting task 'Cleanup' of type 'com.atlassian.bamboo.plugins.scripttask:task.builder.script'
15-Apr-2026 14:48:18
Beginning to execute external process for build 'CASASPECS - Master Test 3.12 - Test Tools Many Linux 2.28 Rocky 8.10 Py3.12 #257 (CASASPECS-MASTERTESTPY312-TTOMLPY38-257)'
... running command line:
/export/home/cbt-el7-1/bamboo-home/temp/CASASPECS-MASTERTESTPY312-TTOMLPY38-257-ScriptBuildTask-11130027518126374665.sh
... in: /export/home/cbt-el7-1/bamboo-home/xml-data/build-dir/CASASPECS-MASTERTESTPY312-TTOMLPY38
15-Apr-2026 14:48:18 Starting cleanup
15-Apr-2026 14:48:29 wheel-container-test
15-Apr-2026 14:48:32 wheel-container-test
15-Apr-2026 14:48:32 Cleanup complete
15-Apr-2026 14:48:32 Finished task 'Cleanup' with result: Success
15-Apr-2026 14:48:32 Running post build plugin 'Docker Container Cleanup'
15-Apr-2026 14:48:32
Beginning to execute external process for build 'CASASPECS - Master Test 3.12 - Test Tools Many Linux 2.28 Rocky 8.10 Py3.12 #257 (CASASPECS-MASTERTESTPY312-TTOMLPY38-257)'
... running command line:
/usr/bin/docker rm -f wheel-container-test
... in: /export/home/cbt-el7-1/bamboo-home/xml-data/build-dir/CASASPECS-MASTERTESTPY312-TTOMLPY38
15-Apr-2026 14:48:32 Error response from daemon: No such container: wheel-container-test
15-Apr-2026 14:48:32 Running post build plugin 'NCover Results Collector'
15-Apr-2026 14:48:32 Running post build plugin 'Build Results Label Collector'
15-Apr-2026 14:48:32 Running post build plugin 'Clover Results Collector'
15-Apr-2026 14:48:32 Running post build plugin 'npm Cache Cleanup'
15-Apr-2026 14:48:32 Running post build plugin 'Artifact Copier'
15-Apr-2026 14:48:32 Publishing an artifact: Workdir
15-Apr-2026 14:48:32 Finished publishing of artifact Non required job artifact Http Compression On : [Workdir], patterns: [work*.tar.gz] anchored at: [wheeldirectory/] in 107.1 ms
15-Apr-2026 14:48:32 Publishing an artifact: XML Directories
15-Apr-2026 14:48:33 Finished publishing of artifact Non required job artifact Http Compression On : [XML Directories], patterns: [**/*.xml] anchored at: [wheeldirectory/] in 247.5 ms
15-Apr-2026 14:48:33 Finalising the build...
15-Apr-2026 14:48:33 Stopping timer.
15-Apr-2026 14:48:33 Build CASASPECS-MASTERTESTPY312-TTOMLPY38-257 completed.
15-Apr-2026 14:48:33 Running on server: post build plugin 'Build Hanging Detection Configuration'
15-Apr-2026 14:48:33 Running on server: post build plugin 'NCover Results Collector'
15-Apr-2026 14:48:33 Running on server: post build plugin 'Build Labeller'
15-Apr-2026 14:48:33 Running on server: post build plugin 'Clover Delta Calculator'
15-Apr-2026 14:48:33 Running on server: post build plugin 'Maven Dependencies Postprocessor'
15-Apr-2026 14:48:33 All post build plugins have finished
15-Apr-2026 14:48:33 Generating build results summary...
15-Apr-2026 14:48:33 Saving build results to disk...
15-Apr-2026 14:48:33 Store variable context...
15-Apr-2026 14:48:33 Finished building CASASPECS-MASTERTESTPY312-TTOMLPY38-257.