File: Test3dBidomainProblemWithPermForEfficiency Type: cpu Showing nodes accounting for 3726ms, 87.69% of 4249ms total Dropped 461 nodes (cum <= 21.25ms) flat flat% sum% cum cum% 0 0% 0% 4241ms 99.81% __libc_start_call_main 0 0% 0% 4241ms 99.81% __libc_start_main_impl 0 0% 0% 4241ms 99.81% _start 0 0% 0% 4238ms 99.74% CxxTest::ErrorFormatter::run (inline) 0 0% 0% 4238ms 99.74% CxxTest::TestRunner::runAllTests (inline) 0 0% 0% 4238ms 99.74% CxxTest::TestRunner::runWorld (inline) 0 0% 0% 4238ms 99.74% main 0 0% 0% 4199ms 98.82% CxxTest::TestRunner::runSuite (inline) 0 0% 0% 4199ms 98.82% CxxTest::TestRunner::runTest (inline) 0 0% 0% 4199ms 98.82% Test3dBidomainProblemWithPermForEfficiency::TestBidomain3d 0 0% 0% 4193ms 98.68% AbstractCardiacProblem::Solve 0 0% 0% 4184ms 98.47% AbstractDynamicLinearPdeSolver::Solve 22ms 0.52% 0.52% 2358ms 55.50% AbstractCardiacTissue::SolveCellSystems 3ms 0.071% 0.59% 1342ms 31.58% LinearSystem::Solve 36ms 0.85% 1.44% 1320ms 31.07% AbstractCardiacCell::ComputeExceptVoltage 0 0% 1.44% 1295ms 30.48% KSPSolve 2ms 0.047% 1.48% 1295ms 30.48% KSPSolve_Private 0 0% 1.48% 1247ms 29.35% KSPSolve_SYMMLQ 34ms 0.8% 2.28% 1103ms 25.96% AbstractOneStepIvpOdeSolver::InternalSolve 70ms 1.65% 3.93% 926ms 21.79% EulerIvpOdeSolver::CalculateNextYValue 236ms 5.55% 9.48% 849ms 19.98% CellLuoRudy1991FromCellML::EvaluateYDerivatives 21ms 0.49% 9.98% 836ms 19.68% AbstractCardiacTissue::UpdateCaches (inline) 2ms 0.047% 10.03% 793ms 18.66% PCApply 2ms 0.047% 10.07% 782ms 18.40% PCApply_BJacobi_Singleblock 374ms 8.80% 18.88% 773ms 18.19% __GI___exp 275ms 6.47% 25.35% 761ms 17.91% CellLuoRudy1991FromCellML::GetIIonic 1ms 0.024% 25.37% 683ms 16.07% KSPSolve_PREONLY (partial-inline) 1ms 0.024% 25.39% 642ms 15.11% MatSolve 0 0% 25.39% 642ms 15.11% PCApply_ICC 632ms 14.87% 40.27% 635ms 14.94% MatSolve_SeqSBAIJ_1_NaturalOrdering 0 0% 40.27% 487ms 11.46% KSP_PCApply.lto_priv.18 4ms 0.094% 40.36% 468ms 11.01% MatMult 2ms 0.047% 40.41% 457ms 10.76% MatMult_SeqAIJ 437ms 10.28% 50.69% 457ms 10.76% MatMult_SeqAIJ_Inode (inline) 91ms 2.14% 52.84% 425ms 10.00% BidomainSolver::SetupLinearSystem 0 0% 52.84% 370ms 8.71% KSPConvergedDefault 289ms 6.80% 59.64% 370ms 8.71% __ieee754_exp_fma 0 0% 59.64% 369ms 8.68% KSP_PCApply (partial-inline) 1ms 0.024% 59.66% 243ms 5.72% std::pow (inline) 26ms 0.61% 60.27% 242ms 5.70% __pow 15ms 0.35% 60.63% 216ms 5.08% __ieee754_pow_fma 67ms 1.58% 62.20% 133ms 3.13% CellLuoRudy1991FromCellML::VerifyStateVariables 113ms 2.66% 64.86% 113ms 2.66% log_inline (inline) 2ms 0.047% 64.91% 104ms 2.45% MatNullSpaceRemove 18ms 0.42% 65.33% 85ms 2.00% MPI_Wtime 74ms 1.74% 67.07% 79ms 1.86% exp_inline (inline) 54ms 1.27% 68.35% 71ms 1.67% top12 (inline) 68ms 1.60% 69.95% 68ms 1.60% [[vdso]] 0 0% 69.95% 67ms 1.58% __GI___clock_gettime 67ms 1.58% 71.52% 67ms 1.58% ddot_ 12ms 0.28% 71.81% 65ms 1.53% AbstractCardiacCell::SetVoltage (partial-inline) 0 0% 71.81% 65ms 1.53% VecDuplicate 12ms 0.28% 72.09% 64ms 1.51% PetscLogEventBeginDefault 23ms 0.54% 72.63% 60ms 1.41% TimeStepper::TimeStepper 0 0% 72.63% 60ms 1.41% VecMDot 4ms 0.094% 72.72% 60ms 1.41% VecMXDot_Private 59ms 1.39% 74.11% 59ms 1.39% [libchaste_heart.so] 1ms 0.024% 74.14% 54ms 1.27% AbstractBidomainSolver::FinaliseLinearSystem 18ms 0.42% 74.56% 53ms 1.25% AbstractBidomainSolver::CheckCompatibilityCondition 9ms 0.21% 74.77% 53ms 1.25% VecCopy 8ms 0.19% 74.96% 51ms 1.20% PetscLogEventEndDefault 41ms 0.96% 75.92% 49ms 1.15% AbstractIvpOdeSolver::SolveAndUpdateStateVariable 0 0% 75.92% 48ms 1.13% VecDot 40ms 0.94% 76.87% 45ms 1.06% AbstractParameterisedSystem::SetAnyVariable 0 0% 76.87% 45ms 1.06% VecDot_Seq 0 0% 76.87% 45ms 1.06% VecXDot_Seq_Private.constprop.0 1ms 0.024% 76.89% 42ms 0.99% VecDuplicate_MPI 5ms 0.12% 77.01% 42ms 0.99% VecMAXPY 41ms 0.96% 77.97% 41ms 0.96% TimeStepper::CalculateNextTime 41ms 0.96% 78.94% 41ms 0.96% asuint64 (inline) 40ms 0.94% 79.88% 40ms 0.94% __ieee754_log_fma 38ms 0.89% 80.77% 39ms 0.92% VecMDot_Seq 0 0% 80.77% 39ms 0.92% VecNorm 38ms 0.89% 81.67% 38ms 0.89% __memcpy_avx_unaligned_erms 29ms 0.68% 82.35% 37ms 0.87% AbstractOneStepIvpOdeSolver::Solve 0 0% 82.35% 36ms 0.85% VecNorm_Seq 12ms 0.28% 82.63% 34ms 0.8% AbstractCardiacCellInterface::SetVoltageDerivativeToZero 0 0% 82.63% 34ms 0.8% CxxTest::RealWorldDescription::setUp 0 0% 82.63% 34ms 0.8% PetscInitialize 0 0% 82.63% 34ms 0.8% PetscSetup::setUpWorld 0 0% 82.63% 34ms 0.8% PetscSetupUtils::CommonSetup 0 0% 82.63% 34ms 0.8% PetscSetupUtils::InitialisePetsc 2ms 0.047% 82.68% 34ms 0.8% VecDestroy 0 0% 82.68% 33ms 0.78% PMPI_Init_thread 0 0% 82.68% 33ms 0.78% ompi_mpi_init 23ms 0.54% 83.22% 32ms 0.75% AbstractParameterisedSystem::GetAnyVariable 30ms 0.71% 83.93% 30ms 0.71% RegularStimulus::GetStimulus 29ms 0.68% 84.61% 29ms 0.68% DistributedVector::Iterator::operator!= 3ms 0.071% 84.68% 29ms 0.68% PetscMallocA 29ms 0.68% 85.36% 29ms 0.68% ReplicatableVector::operator[] 16ms 0.38% 85.74% 29ms 0.68% TimeStepper::AdvanceOneTimeStep 29ms 0.68% 86.42% 29ms 0.68% [libm.so.6] 0 0% 86.42% 27ms 0.64% PetscMemcpy (inline) 1ms 0.024% 86.44% 26ms 0.61% 1ms 0.024% 86.47% 26ms 0.61% PetscMallocAlign 1ms 0.024% 86.49% 26ms 0.61% VecCreate 14ms 0.33% 86.82% 26ms 0.61% std::__cxx11::basic_string::basic_string 0 0% 86.82% 25ms 0.59% VecNorm_MPI 0 0% 86.82% 25ms 0.59% VecNorm_MPI_Default.constprop.0 1ms 0.024% 86.84% 24ms 0.56% VecAXPY 10ms 0.24% 87.08% 23ms 0.54% AbstractCardiacCell::GetVoltage (inline) 3ms 0.071% 87.15% 23ms 0.54% VecCreate_MPI_Private 0 0% 87.15% 23ms 0.54% VecDuplicate_Seq 0 0% 87.15% 23ms 0.54% orte_init 23ms 0.54% 87.69% 23ms 0.54% std::isinf (inline)