File: TestConvergenceEfficiency Type: cpu Showing nodes accounting for 113887ms, 91.96% of 123841ms total Dropped 1146 nodes (cum <= 619.21ms) flat flat% sum% cum cum% 0 0% 0% 123830ms 100% __libc_start_call_main 0 0% 0% 123830ms 100% __libc_start_main_impl 0 0% 0% 123830ms 100% _start 0 0% 0% 123827ms 100% CxxTest::ErrorFormatter::run (inline) 0 0% 0% 123827ms 100% CxxTest::TestRunner::runAllTests (inline) 0 0% 0% 123827ms 100% CxxTest::TestRunner::runWorld (inline) 0 0% 0% 123827ms 100% main 0 0% 0% 123791ms 100% AbstractConvergenceTester::Converge 0 0% 0% 123791ms 100% CxxTest::RealTestDescription::run 0 0% 0% 123791ms 100% CxxTest::TestRunner::runSuite (inline) 0 0% 0% 123791ms 100% CxxTest::TestRunner::runTest (inline) 0 0% 0% 123791ms 100% TestConvergenceEfficiency::Test3DSpace10Efficiency (inline) 0 0% 0% 123791ms 100% TestDescription_TestConvergenceEfficiency_Test3DSpace10Efficiency::runTest (inline) 7ms 0.0057% 0.0057% 122471ms 98.89% AbstractCardiacProblem::Solve 14ms 0.011% 0.017% 121610ms 98.20% AbstractDynamicLinearPdeSolver::Solve 6ms 0.0048% 0.022% 68640ms 55.43% LinearSystem::Solve 5ms 0.004% 0.026% 68076ms 54.97% KSPSolve 15ms 0.012% 0.038% 68071ms 54.97% KSPSolve_Private 15ms 0.012% 0.05% 67624ms 54.61% KSPSolve_SYMMLQ 199ms 0.16% 0.21% 43923ms 35.47% AbstractCardiacTissue::SolveCellSystems 4ms 0.0032% 0.21% 37455ms 30.24% PCApply 2ms 0.0016% 0.22% 37441ms 30.23% PCApply_BJacobi_Singleblock 2ms 0.0016% 0.22% 34763ms 28.07% KSPSolve_PREONLY (partial-inline) 1425ms 1.15% 1.37% 34218ms 27.63% AbstractBackwardEulerCardiacCell::ComputeExceptVoltage 3ms 0.0024% 1.37% 33544ms 27.09% PCApply_ICC 5ms 0.004% 1.37% 33541ms 27.08% MatSolve 33034ms 26.67% 28.05% 33536ms 27.08% MatSolve_SeqSBAIJ_1_NaturalOrdering (partial-inline) 3ms 0.0024% 28.05% 32371ms 26.14% KSP_PCApply.lto_priv.18 6708ms 5.42% 33.47% 29684ms 23.97% CellLuoRudy1991FromCellMLBackwardEulerOpt::ComputeOneStepExceptVoltage 14ms 0.011% 33.48% 23561ms 19.03% MatMult 285ms 0.23% 33.71% 23547ms 19.01% MatMult_SeqAIJ (partial-inline) 23053ms 18.61% 52.32% 23545ms 19.01% MatMult_SeqAIJ_Inode (inline) 2025ms 1.64% 53.96% 15072ms 12.17% CardiacNewtonSolver::Solve 482ms 0.39% 54.35% 8907ms 7.19% AbstractCardiacTissue::UpdateCaches (inline) 4511ms 3.64% 57.99% 8801ms 7.11% CellLuoRudy1991FromCellMLBackwardEulerOpt::ComputeResidual 1404ms 1.13% 59.13% 8498ms 6.86% CellLuoRudy1991FromCellMLBackwardEulerOpt_LookupTables::IndexTable0 (inline) 1901ms 1.54% 60.66% 8215ms 6.63% CellLuoRudy1991FromCellMLBackwardEulerOpt::GetIIonic 1071ms 0.86% 61.52% 7937ms 6.41% BidomainSolver::SetupLinearSystem 1ms 0.00081% 61.53% 7176ms 5.79% KSP_PCApply (partial-inline) 6816ms 5.50% 67.03% 6816ms 5.50% CellLuoRudy1991FromCellMLBackwardEulerOpt_LookupTables::_lookup_0_row (inline) 9ms 0.0073% 67.04% 6553ms 5.29% KSPConvergedDefault 4004ms 3.23% 70.27% 4048ms 3.27% __ieee754_log_fma 0 0% 70.27% 3839ms 3.10% boost::numeric::ublas::norm_inf (inline) 2591ms 2.09% 72.36% 3839ms 3.10% boost::numeric::ublas::vector_norm_inf::apply (inline) 0 0% 72.36% 3839ms 3.10% boost::numeric::ublas::vector_scalar_unary::evaluate (inline) 0 0% 72.36% 3839ms 3.10% boost::numeric::ublas::vector_scalar_unary::operator double (inline) 3607ms 2.91% 75.27% 3607ms 2.91% __memcpy_avx_unaligned_erms 0 0% 75.27% 3571ms 2.88% PetscMemcpy (inline) 9ms 0.0073% 75.28% 3440ms 2.78% MatNullSpaceRemove 21ms 0.017% 75.30% 3111ms 2.51% VecCopy 5ms 0.004% 75.30% 3086ms 2.49% VecCopy_Seq (partial-inline) 15ms 0.012% 75.32% 3034ms 2.45% std::pow (inline) 349ms 0.28% 75.60% 3009ms 2.43% __pow 2940ms 2.37% 77.97% 2940ms 2.37% ddot_ 1741ms 1.41% 79.38% 2923ms 2.36% CellLuoRudy1991FromCellMLBackwardEulerOpt::VerifyStateVariables 20ms 0.016% 79.39% 2746ms 2.22% VecAXPY 5ms 0.004% 79.40% 2726ms 2.20% VecAXPY_Seq 2713ms 2.19% 81.59% 2713ms 2.19% daxpy_ 348ms 0.28% 81.87% 2653ms 2.14% __ieee754_pow_fma 1ms 0.00081% 81.87% 2475ms 2.00% VecDot 1ms 0.00081% 81.87% 2474ms 2.00% VecDot_Seq 1ms 0.00081% 81.87% 2473ms 2.00% VecXDot_Seq_Private.constprop.0 5ms 0.004% 81.88% 2080ms 1.68% AbstractFeVolumeIntegralAssembler::DoAssemble 3ms 0.0024% 81.88% 1998ms 1.61% VecMDot 12ms 0.0097% 81.89% 1995ms 1.61% VecMXDot_Private 1971ms 1.59% 83.48% 1977ms 1.60% VecMDot_Seq 34ms 0.027% 83.51% 1739ms 1.40% AbstractFeVolumeIntegralAssembler::AssembleOnElement 1504ms 1.21% 84.72% 1574ms 1.27% exp_inline (inline) 2ms 0.0016% 84.72% 1433ms 1.16% VecMAXPY 1424ms 1.15% 85.87% 1431ms 1.16% VecMAXPY_Seq 0 0% 85.87% 1428ms 1.15% AbstractFeAssemblerInterface::AssembleMatrix (inline) 1300ms 1.05% 86.92% 1300ms 1.05% __memset_avx2_unaligned_erms 0 0% 86.92% 1293ms 1.04% PetscMemzero (inline) 1278ms 1.03% 87.95% 1278ms 1.03% CellLuoRudy1991FromCellMLBackwardEulerOpt_LookupTables::CheckIndex0 (inline) 12ms 0.0097% 87.96% 1170ms 0.94% boost::numeric::ublas::matrix_assign (inline) 0 0% 87.96% 1168ms 0.94% boost::numeric::ublas::scalar_traits::norm_inf (inline) 0 0% 87.96% 1168ms 0.94% boost::numeric::ublas::scalar_traits::type_abs (inline) 0 0% 87.96% 1168ms 0.94% boost_numeric_ublas_abs (inline) 1168ms 0.94% 88.91% 1168ms 0.94% std::abs (inline) 226ms 0.18% 89.09% 1150ms 0.93% boost::numeric::ublas::indexing_matrix_assign 0 0% 89.09% 1147ms 0.93% AbstractTetrahedralMesh::ConstructRegularSlabMesh 0 0% 89.09% 1147ms 0.93% CuboidMeshConstructor::Construct 0 0% 89.09% 1147ms 0.93% DistributedTetrahedralMesh::ConstructCuboid 818ms 0.66% 89.75% 1095ms 0.88% CellLuoRudy1991FromCellMLBackwardEulerOpt_LookupTables::Instance 1ms 0.00081% 89.75% 1090ms 0.88% KSP_RemoveNullSpace (inline) 7ms 0.0057% 89.76% 1043ms 0.84% VecDuplicate 2ms 0.0016% 89.76% 1035ms 0.84% Element::Element 2ms 0.0016% 89.76% 1020ms 0.82% AbstractTetrahedralElement::CalculateJacobian 3ms 0.0024% 89.76% 967ms 0.78% AbstractTetrahedralElement::AbstractTetrahedralElement 6ms 0.0048% 89.77% 888ms 0.72% BidomainAssembler::ComputeMatrixTerm 4ms 0.0032% 89.77% 886ms 0.72% boost::numeric::ublas::c_matrix::c_matrix (inline) 4ms 0.0032% 89.77% 885ms 0.71% VecScale 4ms 0.0032% 89.78% 881ms 0.71% VecScale_Seq 880ms 0.71% 90.49% 880ms 0.71% [libchaste_heart.so] 875ms 0.71% 91.19% 875ms 0.71% dscal_ 7ms 0.0057% 91.20% 866ms 0.7% PetscMallocA 5ms 0.004% 91.20% 859ms 0.69% PetscMallocAlign (partial-inline) 1ms 0.00081% 91.20% 799ms 0.65% BidomainProblem::WriteOneStep 230ms 0.19% 91.39% 785ms 0.63% AbstractBidomainSolver::CheckCompatibilityCondition 0 0% 91.39% 785ms 0.63% AbstractBidomainSolver::FinaliseLinearSystem 2ms 0.0016% 91.39% 724ms 0.58% VecNorm 0 0% 91.39% 715ms 0.58% VecNorm_Seq 701ms 0.57% 91.96% 701ms 0.57% log_inline (inline) 6ms 0.0048% 91.96% 666ms 0.54% VecDuplicate_Seq 0 0% 91.96% 652ms 0.53% AbstractFeAssemblerInterface::Assemble (inline) 0 0% 91.96% 621ms 0.5% boost::numeric::ublas::matrix_slice::operator= (inline)