builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-047 starttime: 1479213670.69 results: success (0) buildid: 20161115032613 builduid: ea2098eee9814a1b9e908f937c645cc7 revision: 85a9d908e91a7071bbb1f554b275fb1b4e796e34 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:10.689438) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:10.690292) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:10.690609) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:10.732794) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:10.733124) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-11-15 04:41:10-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 37.8M=0s 2016-11-15 04:41:10 (37.8 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.076218 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:10.828338) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:10.828716) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021077 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:10.886828) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-15 04:41:10.887190) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 85a9d908e91a7071bbb1f554b275fb1b4e796e34 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 85a9d908e91a7071bbb1f554b275fb1b4e796e34 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-11-15 04:41:11,131 truncating revision to first 12 chars 2016-11-15 04:41:11,132 Setting DEBUG logging. 2016-11-15 04:41:11,132 attempt 1/10 2016-11-15 04:41:11,132 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/85a9d908e91a?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-11-15 04:41:11,968 unpacking tar archive at: mozilla-central-85a9d908e91a/testing/mozharness/ program finished with exit code 0 elapsedTime=1.173526 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-15 04:41:12.086365) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:12.086736) ========= script_repo_revision: 85a9d908e91a7071bbb1f554b275fb1b4e796e34 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:12.087175) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:12.087443) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-15 04:41:12.098297) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 50 secs) (at 2016-11-15 04:41:12.098720) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:41:12 INFO - MultiFileLogger online at 20161115 04:41:12 in /builds/slave/test 04:41:12 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 04:41:12 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:41:12 INFO - {'append_to_log': False, 04:41:12 INFO - 'base_work_dir': '/builds/slave/test', 04:41:12 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 04:41:12 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:41:12 INFO - 'branch': 'Firefox-Non-PGO', 04:41:12 INFO - 'buildbot_json_path': 'buildprops.json', 04:41:12 INFO - 'config_files': ('talos/linux_config.py',), 04:41:12 INFO - 'default_actions': ('clobber', 04:41:12 INFO - 'read-buildbot-config', 04:41:12 INFO - 'download-and-extract', 04:41:12 INFO - 'populate-webroot', 04:41:12 INFO - 'create-virtualenv', 04:41:12 INFO - 'install', 04:41:12 INFO - 'run-tests'), 04:41:12 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:41:12 INFO - 'download_minidump_stackwalk': True, 04:41:12 INFO - 'download_symbols': 'ondemand', 04:41:12 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:41:12 INFO - 'tooltool.py': '/tools/tooltool.py', 04:41:12 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:41:12 INFO - '/tools/misc-python/virtualenv.py')}, 04:41:12 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:41:12 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:41:12 INFO - 'installer_path': 'installer.exe', 04:41:12 INFO - 'log_level': 'info', 04:41:12 INFO - 'log_name': 'talos', 04:41:12 INFO - 'log_to_console': True, 04:41:12 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:41:12 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:41:12 INFO - 'opt_config_files': (), 04:41:12 INFO - 'pip_index': False, 04:41:12 INFO - 'sps_profile': False, 04:41:12 INFO - 'sps_profile_interval': 0, 04:41:12 INFO - 'suite': 'dromaeojs', 04:41:12 INFO - 'system_bits': '32', 04:41:12 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:41:12 INFO - 'title': 'talos-linux64-ix-047', 04:41:12 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:41:12 INFO - 'use_talos_json': True, 04:41:12 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:41:12 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:41:12 INFO - 'work_dir': 'build'} 04:41:12 INFO - [mozharness: 2016-11-15 12:41:12.424273Z] Running clobber step. 04:41:12 INFO - Running pre-action listener: _resource_record_pre_action 04:41:12 INFO - Running main action method: clobber 04:41:12 INFO - rmtree: /builds/slave/test/build 04:41:12 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:41:13 INFO - Running post-action listener: _resource_record_post_action 04:41:13 INFO - [mozharness: 2016-11-15 12:41:13.402913Z] Finished clobber step (success) 04:41:13 INFO - [mozharness: 2016-11-15 12:41:13.403013Z] Running read-buildbot-config step. 04:41:13 INFO - Running pre-action listener: _resource_record_pre_action 04:41:13 INFO - Running main action method: read_buildbot_config 04:41:13 INFO - Using buildbot properties: 04:41:13 INFO - { 04:41:13 INFO - "project": "", 04:41:13 INFO - "product": "firefox", 04:41:13 INFO - "script_repo_revision": "production", 04:41:13 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 04:41:13 INFO - "repository": "", 04:41:13 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 04:41:13 INFO - "buildid": "20161115032613", 04:41:13 INFO - "pgo_build": "False", 04:41:13 INFO - "basedir": "/builds/slave/test", 04:41:13 INFO - "buildnumber": 813, 04:41:13 INFO - "slavename": "talos-linux64-ix-047", 04:41:13 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 04:41:13 INFO - "platform": "ubuntu64_hw", 04:41:13 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 04:41:13 INFO - "branch": "mozilla-central", 04:41:13 INFO - "repo_path": "mozilla-central", 04:41:13 INFO - "revision": "85a9d908e91a7071bbb1f554b275fb1b4e796e34", 04:41:13 INFO - "stage_platform": "linux64", 04:41:13 INFO - "builduid": "ea2098eee9814a1b9e908f937c645cc7", 04:41:13 INFO - "slavebuilddir": "test" 04:41:13 INFO - } 04:41:13 INFO - Found installer url https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2. 04:41:13 INFO - Running post-action listener: _resource_record_post_action 04:41:13 INFO - [mozharness: 2016-11-15 12:41:13.405489Z] Finished read-buildbot-config step (success) 04:41:13 INFO - [mozharness: 2016-11-15 12:41:13.405578Z] Running download-and-extract step. 04:41:13 INFO - Running pre-action listener: _resource_record_pre_action 04:41:13 INFO - Running main action method: download_and_extract 04:41:13 INFO - mkdir: /builds/slave/test/build/tests 04:41:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:13 INFO - trying https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 04:41:13 INFO - Downloading https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 04:41:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 04:41:13 INFO - Downloaded 1361 bytes. 04:41:13 INFO - Reading from file /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 04:41:13 INFO - Using the following test package requirements: 04:41:13 INFO - {u'common': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'], 04:41:13 INFO - u'cppunittest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 04:41:13 INFO - u'firefox-53.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:41:13 INFO - u'gtest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 04:41:13 INFO - u'firefox-53.0a1.en-US.linux-x86_64.gtest.tests.zip'], 04:41:13 INFO - u'jittest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 04:41:13 INFO - u'jsshell-linux-x86_64.zip'], 04:41:13 INFO - u'mochitest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 04:41:13 INFO - u'firefox-53.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:41:13 INFO - u'mozbase': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'], 04:41:13 INFO - u'reftest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 04:41:13 INFO - u'firefox-53.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:41:13 INFO - u'talos': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 04:41:13 INFO - u'firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:41:13 INFO - u'web-platform': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 04:41:13 INFO - u'firefox-53.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:41:13 INFO - u'xpcshell': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 04:41:13 INFO - u'firefox-53.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:41:13 INFO - Downloading packages: [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:41:13 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip 04:41:13 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:41:13 INFO - Fetch https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip into memory 04:41:14 INFO - Http code: 200 04:41:14 INFO - via: 1.1 a1aa00de8387e7235a256b2a5b73ede8.cloudfront.net (CloudFront) 04:41:14 INFO - x-amz-cf-id: QYxu_MrF9XXlvYS4EzxzkM4VJUZyHV8f-aO6smtQUnF83duGjbK-_g== 04:41:14 INFO - x-amz-version-id: .OKaJtHG1K1qWTaSR8CwTb3E05FB3kLK 04:41:14 INFO - Expected file size: 20414264 04:41:14 INFO - Obtained file size: 20414264 04:41:18 INFO - Downloading packages: [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:41:18 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip 04:41:18 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:41:18 INFO - Fetch https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip into memory 04:41:19 INFO - Http code: 200 04:41:19 INFO - via: 1.1 5c2ff4ca1e447265402af29264e83497.cloudfront.net (CloudFront) 04:41:19 INFO - x-amz-cf-id: UPeEdbXBYluhgvfOsNZYv01F9A8h2Q-wA137RYUwFzJVmzOqckyKuw== 04:41:19 INFO - x-amz-version-id: .OKaJtHG1K1qWTaSR8CwTb3E05FB3kLK 04:41:19 INFO - Expected file size: 20414264 04:41:19 INFO - Obtained file size: 20414264 04:41:24 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip 04:41:24 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:41:24 INFO - Fetch https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip into memory 04:41:24 INFO - Http code: 200 04:41:24 INFO - via: 1.1 73fa5a1ee49cf827e596b502b5927eab.cloudfront.net (CloudFront) 04:41:24 INFO - x-amz-cf-id: AX3yqqWGhLFmP0-FiAYO5dJ-h4n73o3SPFLcQjlttcOx7WQXf8lp4Q== 04:41:24 INFO - x-amz-version-id: Mnpb0Ztuc9oHnKD.V20B.i7h4IJ.yZ.N 04:41:25 INFO - Expected file size: 14409038 04:41:25 INFO - Obtained file size: 14409038 04:41:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:25 INFO - trying https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 04:41:25 INFO - Downloading https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 04:41:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 04:41:27 INFO - Downloaded 55708018 bytes. 04:41:27 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 04:41:27 INFO - mkdir: /builds/slave/test/properties 04:41:27 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:41:27 INFO - Writing to file /builds/slave/test/properties/build_url 04:41:27 INFO - Contents: 04:41:27 INFO - build_url:https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 04:41:28 INFO - Running post-action listener: _resource_record_post_action 04:41:28 INFO - Running post-action listener: set_extra_try_arguments 04:41:28 INFO - [mozharness: 2016-11-15 12:41:28.609331Z] Finished download-and-extract step (success) 04:41:28 INFO - [mozharness: 2016-11-15 12:41:28.609558Z] Running populate-webroot step. 04:41:28 INFO - Running pre-action listener: _resource_record_pre_action 04:41:28 INFO - Running main action method: populate_webroot 04:41:28 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:41:28 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:41:28 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:41:28 INFO - '--tppagecycles', 04:41:28 INFO - '7'], 04:41:28 INFO - 'tests': ['tsvgm']}}, 04:41:28 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:41:28 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:41:28 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:41:28 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:41:28 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:41:28 INFO - 'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:41:28 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:41:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:41:28 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:41:28 INFO - 'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['damp', 'tps']}, 04:41:28 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:41:28 INFO - 'tests': ['damp', 'tps']}, 04:41:28 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['dromaeo_dom']}, 04:41:28 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:41:28 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['basic_compositor_video']}, 04:41:28 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 04:41:28 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['a11yr', 04:41:28 INFO - 'ts_paint', 04:41:28 INFO - 'tpaint', 04:41:28 INFO - 'sessionrestore', 04:41:28 INFO - 'sessionrestore_no_auto_restore', 04:41:28 INFO - 'tabpaint']}, 04:41:28 INFO - 'other-e10s': {'tests': ['a11yr', 04:41:28 INFO - 'ts_paint', 04:41:28 INFO - 'tpaint', 04:41:28 INFO - 'sessionrestore', 04:41:28 INFO - 'sessionrestore_no_auto_restore', 04:41:28 INFO - 'tabpaint']}, 04:41:28 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:41:28 INFO - 'ts_paint', 04:41:28 INFO - 'tpaint', 04:41:28 INFO - 'sessionrestore', 04:41:28 INFO - 'sessionrestore_no_auto_restore', 04:41:28 INFO - 'tabpaint']}, 04:41:28 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:41:28 INFO - 'ts_paint', 04:41:28 INFO - 'tpaint', 04:41:28 INFO - 'sessionrestore', 04:41:28 INFO - 'sessionrestore_no_auto_restore', 04:41:28 INFO - 'tabpaint']}, 04:41:28 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['a11yr', 04:41:28 INFO - 'ts_paint', 04:41:28 INFO - 'tpaint', 04:41:28 INFO - 'sessionrestore', 04:41:28 INFO - 'sessionrestore_no_auto_restore', 04:41:28 INFO - 'tabpaint']}, 04:41:28 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['a11yr', 04:41:28 INFO - 'ts_paint', 04:41:28 INFO - 'tpaint', 04:41:28 INFO - 'sessionrestore', 04:41:28 INFO - 'sessionrestore_no_auto_restore', 04:41:28 INFO - 'tabpaint']}, 04:41:28 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['tsvgx', 04:41:28 INFO - 'tsvgr_opacity', 04:41:28 INFO - 'tart', 04:41:28 INFO - 'tscrollx', 04:41:28 INFO - 'cart']}, 04:41:28 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:41:28 INFO - 'tsvgr_opacity', 04:41:28 INFO - 'tart', 04:41:28 INFO - 'tscrollx', 04:41:28 INFO - 'cart']}, 04:41:28 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:41:28 INFO - 'talos_options': ['--disable-e10s'], 04:41:28 INFO - 'tests': ['tp5o']}, 04:41:28 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:41:28 INFO - 'tests': ['tp5o']}, 04:41:28 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:41:28 INFO - 'talos_options': ['--disable-e10s', 04:41:28 INFO - '--xperf_path', 04:41:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:41:28 INFO - 'tests': ['tp5n']}, 04:41:28 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:41:28 INFO - 'talos_options': ['--xperf_path', 04:41:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:41:28 INFO - 'tests': ['tp5n']}}, 04:41:28 INFO - 'talos.zip': {'path': '', 04:41:28 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:41:28 INFO - Running post-action listener: _resource_record_post_action 04:41:28 INFO - [mozharness: 2016-11-15 12:41:28.630088Z] Finished populate-webroot step (success) 04:41:28 INFO - [mozharness: 2016-11-15 12:41:28.630176Z] Running create-virtualenv step. 04:41:28 INFO - Running pre-action listener: _resource_record_pre_action 04:41:28 INFO - Running main action method: create_virtualenv 04:41:28 INFO - Creating virtualenv /builds/slave/test/build/venv 04:41:28 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 04:41:28 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:41:28 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:41:28 INFO - Using real prefix '/usr' 04:41:28 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:41:29 INFO - Installing distribute.............................................................................................................................................................................................done. 04:41:31 INFO - Installing pip.................done. 04:41:31 INFO - Return code: 0 04:41:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 04:41:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 04:41:31 INFO - Reading from file tmpfile_stdout 04:41:31 INFO - Output received: 04:41:31 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 04:41:31 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:41:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 04:41:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 04:41:31 INFO - Using env: {'DISPLAY': ':0', 04:41:31 INFO - 'HOME': '/home/cltbld', 04:41:31 INFO - 'LANG': 'en_US.UTF-8', 04:41:31 INFO - 'LANGUAGE': 'en_US:en', 04:41:31 INFO - 'LOGNAME': 'cltbld', 04:41:31 INFO - 'MAIL': '/var/mail/cltbld', 04:41:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:31 INFO - 'MOZ_NO_REMOTE': '1', 04:41:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:31 INFO - 'NO_EM_RESTART': '1', 04:41:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:31 INFO - 'PWD': '/builds/slave/test', 04:41:31 INFO - 'SHELL': '/bin/bash', 04:41:31 INFO - 'SHLVL': '1', 04:41:31 INFO - 'TERM': 'linux', 04:41:31 INFO - 'TMOUT': '86400', 04:41:31 INFO - 'USER': 'cltbld', 04:41:31 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:31 INFO - '_': '/tools/buildbot/bin/python'} 04:41:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:31 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 04:41:31 INFO - Cleaning up... 04:41:31 INFO - Return code: 0 04:41:31 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:41:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 04:41:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 04:41:31 INFO - Using env: {'DISPLAY': ':0', 04:41:31 INFO - 'HOME': '/home/cltbld', 04:41:31 INFO - 'LANG': 'en_US.UTF-8', 04:41:31 INFO - 'LANGUAGE': 'en_US:en', 04:41:31 INFO - 'LOGNAME': 'cltbld', 04:41:31 INFO - 'MAIL': '/var/mail/cltbld', 04:41:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:31 INFO - 'MOZ_NO_REMOTE': '1', 04:41:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:31 INFO - 'NO_EM_RESTART': '1', 04:41:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:31 INFO - 'PWD': '/builds/slave/test', 04:41:31 INFO - 'SHELL': '/bin/bash', 04:41:31 INFO - 'SHLVL': '1', 04:41:31 INFO - 'TERM': 'linux', 04:41:31 INFO - 'TMOUT': '86400', 04:41:31 INFO - 'USER': 'cltbld', 04:41:31 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:31 INFO - '_': '/tools/buildbot/bin/python'} 04:41:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:31 INFO - Downloading/unpacking psutil>=3.1.1 04:41:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:41:33 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:41:33 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:41:33 INFO - Installing collected packages: psutil 04:41:33 INFO - Running setup.py install for psutil 04:41:34 INFO - building 'psutil._psutil_linux' extension 04:41:34 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 04:41:34 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 04:41:34 INFO - building 'psutil._psutil_posix' extension 04:41:34 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 04:41:34 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 04:41:34 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:41:34 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:41:34 INFO - Successfully installed psutil 04:41:34 INFO - Cleaning up... 04:41:34 INFO - Return code: 0 04:41:34 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:41:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 04:41:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 04:41:34 INFO - Using env: {'DISPLAY': ':0', 04:41:34 INFO - 'HOME': '/home/cltbld', 04:41:34 INFO - 'LANG': 'en_US.UTF-8', 04:41:34 INFO - 'LANGUAGE': 'en_US:en', 04:41:34 INFO - 'LOGNAME': 'cltbld', 04:41:34 INFO - 'MAIL': '/var/mail/cltbld', 04:41:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:34 INFO - 'MOZ_NO_REMOTE': '1', 04:41:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:34 INFO - 'NO_EM_RESTART': '1', 04:41:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:34 INFO - 'PWD': '/builds/slave/test', 04:41:34 INFO - 'SHELL': '/bin/bash', 04:41:34 INFO - 'SHLVL': '1', 04:41:34 INFO - 'TERM': 'linux', 04:41:34 INFO - 'TMOUT': '86400', 04:41:34 INFO - 'USER': 'cltbld', 04:41:34 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:34 INFO - '_': '/tools/buildbot/bin/python'} 04:41:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:34 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:41:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:36 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:41:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:41:36 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:41:36 INFO - Installing collected packages: mozsystemmonitor 04:41:36 INFO - Running setup.py install for mozsystemmonitor 04:41:36 INFO - Successfully installed mozsystemmonitor 04:41:36 INFO - Cleaning up... 04:41:36 INFO - Return code: 0 04:41:36 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:41:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 04:41:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 04:41:36 INFO - Using env: {'DISPLAY': ':0', 04:41:36 INFO - 'HOME': '/home/cltbld', 04:41:36 INFO - 'LANG': 'en_US.UTF-8', 04:41:36 INFO - 'LANGUAGE': 'en_US:en', 04:41:36 INFO - 'LOGNAME': 'cltbld', 04:41:36 INFO - 'MAIL': '/var/mail/cltbld', 04:41:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:36 INFO - 'MOZ_NO_REMOTE': '1', 04:41:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:36 INFO - 'NO_EM_RESTART': '1', 04:41:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:36 INFO - 'PWD': '/builds/slave/test', 04:41:36 INFO - 'SHELL': '/bin/bash', 04:41:36 INFO - 'SHLVL': '1', 04:41:36 INFO - 'TERM': 'linux', 04:41:36 INFO - 'TMOUT': '86400', 04:41:36 INFO - 'USER': 'cltbld', 04:41:36 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:36 INFO - '_': '/tools/buildbot/bin/python'} 04:41:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:37 INFO - Downloading/unpacking jsonschema==2.5.1 04:41:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:39 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:41:39 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:41:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:39 INFO - Downloading functools32-3.2.3-2.tar.gz 04:41:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:41:39 INFO - warning: no files found matching '*.txt' 04:41:39 INFO - no previously-included directories found matching 'build' 04:41:39 INFO - no previously-included directories found matching 'dist' 04:41:39 INFO - no previously-included directories found matching '.git*' 04:41:39 INFO - Installing collected packages: jsonschema, functools32 04:41:39 INFO - Running setup.py install for functools32 04:41:39 INFO - warning: no files found matching '*.txt' 04:41:39 INFO - no previously-included directories found matching 'build' 04:41:39 INFO - no previously-included directories found matching 'dist' 04:41:39 INFO - no previously-included directories found matching '.git*' 04:41:39 INFO - Successfully installed jsonschema functools32 04:41:39 INFO - Cleaning up... 04:41:39 INFO - Return code: 0 04:41:39 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 04:41:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 04:41:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 04:41:39 INFO - Using env: {'DISPLAY': ':0', 04:41:39 INFO - 'HOME': '/home/cltbld', 04:41:39 INFO - 'LANG': 'en_US.UTF-8', 04:41:39 INFO - 'LANGUAGE': 'en_US:en', 04:41:39 INFO - 'LOGNAME': 'cltbld', 04:41:39 INFO - 'MAIL': '/var/mail/cltbld', 04:41:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:39 INFO - 'MOZ_NO_REMOTE': '1', 04:41:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:39 INFO - 'NO_EM_RESTART': '1', 04:41:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:39 INFO - 'PWD': '/builds/slave/test', 04:41:39 INFO - 'SHELL': '/bin/bash', 04:41:39 INFO - 'SHLVL': '1', 04:41:39 INFO - 'TERM': 'linux', 04:41:39 INFO - 'TMOUT': '86400', 04:41:39 INFO - 'USER': 'cltbld', 04:41:39 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:39 INFO - '_': '/tools/buildbot/bin/python'} 04:41:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:40 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 04:41:40 INFO - Cleaning up... 04:41:40 INFO - Return code: 0 04:41:40 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:41:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 04:41:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 04:41:40 INFO - Using env: {'DISPLAY': ':0', 04:41:40 INFO - 'HOME': '/home/cltbld', 04:41:40 INFO - 'LANG': 'en_US.UTF-8', 04:41:40 INFO - 'LANGUAGE': 'en_US:en', 04:41:40 INFO - 'LOGNAME': 'cltbld', 04:41:40 INFO - 'MAIL': '/var/mail/cltbld', 04:41:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:40 INFO - 'MOZ_NO_REMOTE': '1', 04:41:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:40 INFO - 'NO_EM_RESTART': '1', 04:41:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:40 INFO - 'PWD': '/builds/slave/test', 04:41:40 INFO - 'SHELL': '/bin/bash', 04:41:40 INFO - 'SHLVL': '1', 04:41:40 INFO - 'TERM': 'linux', 04:41:40 INFO - 'TMOUT': '86400', 04:41:40 INFO - 'USER': 'cltbld', 04:41:40 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:40 INFO - '_': '/tools/buildbot/bin/python'} 04:41:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:40 INFO - Downloading/unpacking blobuploader==1.2.4 04:41:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:40 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:40 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:42 INFO - Downloading blobuploader-1.2.4.tar.gz 04:41:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:41:42 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:41:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:41:42 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:41:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:42 INFO - Downloading docopt-0.6.1.tar.gz 04:41:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:41:43 INFO - Installing collected packages: blobuploader, requests, docopt 04:41:43 INFO - Running setup.py install for blobuploader 04:41:43 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:41:43 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:41:43 INFO - Running setup.py install for requests 04:41:43 INFO - Running setup.py install for docopt 04:41:43 INFO - Successfully installed blobuploader requests docopt 04:41:43 INFO - Cleaning up... 04:41:43 INFO - Return code: 0 04:41:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:41:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:41:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:41:43 INFO - Using env: {'DISPLAY': ':0', 04:41:43 INFO - 'HOME': '/home/cltbld', 04:41:43 INFO - 'LANG': 'en_US.UTF-8', 04:41:43 INFO - 'LANGUAGE': 'en_US:en', 04:41:43 INFO - 'LOGNAME': 'cltbld', 04:41:43 INFO - 'MAIL': '/var/mail/cltbld', 04:41:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:43 INFO - 'MOZ_NO_REMOTE': '1', 04:41:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:43 INFO - 'NO_EM_RESTART': '1', 04:41:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:43 INFO - 'PWD': '/builds/slave/test', 04:41:43 INFO - 'SHELL': '/bin/bash', 04:41:43 INFO - 'SHLVL': '1', 04:41:43 INFO - 'TERM': 'linux', 04:41:43 INFO - 'TMOUT': '86400', 04:41:43 INFO - 'USER': 'cltbld', 04:41:43 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:43 INFO - '_': '/tools/buildbot/bin/python'} 04:41:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:41:43 INFO - Running setup.py (path:/tmp/pip-cSRWgQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:41:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:41:43 INFO - Running setup.py (path:/tmp/pip-Vq7SDA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:41:44 INFO - Running setup.py (path:/tmp/pip-aY2OM0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:41:44 INFO - Running setup.py (path:/tmp/pip-q49flz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:41:44 INFO - Running setup.py (path:/tmp/pip-oWSFQI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:41:44 INFO - Running setup.py (path:/tmp/pip-Q01n50-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:41:44 INFO - Running setup.py (path:/tmp/pip-tOz1Gr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:41:44 INFO - Running setup.py (path:/tmp/pip-ucDqw9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:41:44 INFO - Running setup.py (path:/tmp/pip-8pi0um-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:41:44 INFO - Running setup.py (path:/tmp/pip-781NUM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:41:44 INFO - Running setup.py (path:/tmp/pip-v4Fbvc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:41:44 INFO - Running setup.py (path:/tmp/pip-cxmlGd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:41:44 INFO - Running setup.py (path:/tmp/pip-XUAuwW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:41:44 INFO - Running setup.py (path:/tmp/pip-bZzjm0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:41:44 INFO - Running setup.py (path:/tmp/pip-xpfFLC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:41:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:41:44 INFO - Running setup.py (path:/tmp/pip-PInSan-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:41:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:41:45 INFO - Running setup.py (path:/tmp/pip-xqwXq6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:41:45 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:41:45 INFO - Running setup.py install for manifestparser 04:41:45 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:41:45 INFO - Running setup.py install for mozcrash 04:41:45 INFO - Running setup.py install for mozdebug 04:41:45 INFO - Running setup.py install for mozdevice 04:41:45 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:41:45 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:41:45 INFO - Running setup.py install for mozfile 04:41:45 INFO - Running setup.py install for mozhttpd 04:41:45 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:41:45 INFO - Running setup.py install for mozinfo 04:41:45 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:41:45 INFO - Running setup.py install for mozInstall 04:41:45 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:41:45 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:41:45 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:41:45 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:41:45 INFO - Running setup.py install for mozleak 04:41:46 INFO - Running setup.py install for mozlog 04:41:46 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:41:46 INFO - Running setup.py install for moznetwork 04:41:46 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:41:46 INFO - Running setup.py install for mozprocess 04:41:46 INFO - Running setup.py install for mozprofile 04:41:46 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:41:46 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:41:46 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:41:46 INFO - Running setup.py install for mozrunner 04:41:46 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:41:46 INFO - Running setup.py install for mozscreenshot 04:41:46 INFO - Running setup.py install for moztest 04:41:46 INFO - Running setup.py install for mozversion 04:41:46 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:41:46 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:41:46 INFO - Cleaning up... 04:41:46 INFO - Return code: 0 04:41:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:41:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:41:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:41:46 INFO - Using env: {'DISPLAY': ':0', 04:41:46 INFO - 'HOME': '/home/cltbld', 04:41:46 INFO - 'LANG': 'en_US.UTF-8', 04:41:46 INFO - 'LANGUAGE': 'en_US:en', 04:41:46 INFO - 'LOGNAME': 'cltbld', 04:41:46 INFO - 'MAIL': '/var/mail/cltbld', 04:41:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:46 INFO - 'MOZ_NO_REMOTE': '1', 04:41:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:46 INFO - 'NO_EM_RESTART': '1', 04:41:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:46 INFO - 'PWD': '/builds/slave/test', 04:41:46 INFO - 'SHELL': '/bin/bash', 04:41:46 INFO - 'SHLVL': '1', 04:41:46 INFO - 'TERM': 'linux', 04:41:46 INFO - 'TMOUT': '86400', 04:41:46 INFO - 'USER': 'cltbld', 04:41:46 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:46 INFO - '_': '/tools/buildbot/bin/python'} 04:41:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:41:47 INFO - Running setup.py (path:/tmp/pip-7TMIA1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:41:47 INFO - Running setup.py (path:/tmp/pip-6wpRxR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:41:47 INFO - Running setup.py (path:/tmp/pip-N7EVW_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:41:47 INFO - Running setup.py (path:/tmp/pip-TRWlRv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:41:47 INFO - Running setup.py (path:/tmp/pip-8siTmR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:41:47 INFO - Running setup.py (path:/tmp/pip-1ulkMI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:41:47 INFO - Running setup.py (path:/tmp/pip-BaiNDB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:41:47 INFO - Running setup.py (path:/tmp/pip-OTSubu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:41:47 INFO - Running setup.py (path:/tmp/pip-vXSzlt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:41:47 INFO - Running setup.py (path:/tmp/pip-BrGyLR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:41:47 INFO - Running setup.py (path:/tmp/pip-YA5PX4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:41:47 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 04:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:41:47 INFO - Running setup.py (path:/tmp/pip-yCpr3L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 04:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:41:48 INFO - Running setup.py (path:/tmp/pip-pVIGZe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 04:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:41:48 INFO - Running setup.py (path:/tmp/pip-43qPkn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 04:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:41:48 INFO - Running setup.py (path:/tmp/pip-axh0mF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 04:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:41:48 INFO - Running setup.py (path:/tmp/pip-FcDquk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 04:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:41:48 INFO - Running setup.py (path:/tmp/pip-05xN_h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:41:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:41:48 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:41:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:41:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:41:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:41:50 INFO - Downloading blessings-1.6.tar.gz 04:41:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:41:50 INFO - Installing collected packages: blessings 04:41:50 INFO - Running setup.py install for blessings 04:41:50 INFO - Successfully installed blessings 04:41:50 INFO - Cleaning up... 04:41:50 INFO - Return code: 0 04:41:50 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:41:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:41:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:41:50 INFO - Reading from file tmpfile_stdout 04:41:50 INFO - Current package versions: 04:41:50 INFO - argparse == 1.2.1 04:41:50 INFO - blessings == 1.6 04:41:50 INFO - blobuploader == 1.2.4 04:41:50 INFO - docopt == 0.6.1 04:41:50 INFO - functools32 == 3.2.3-2 04:41:50 INFO - jsonschema == 2.5.1 04:41:50 INFO - manifestparser == 1.1 04:41:50 INFO - mozInstall == 1.12 04:41:50 INFO - mozcrash == 1.0 04:41:50 INFO - mozdebug == 0.1 04:41:50 INFO - mozdevice == 0.48 04:41:50 INFO - mozfile == 1.2 04:41:50 INFO - mozhttpd == 0.7 04:41:50 INFO - mozinfo == 0.9 04:41:50 INFO - mozleak == 0.1 04:41:50 INFO - mozlog == 3.4 04:41:50 INFO - moznetwork == 0.27 04:41:50 INFO - mozprocess == 0.23 04:41:50 INFO - mozprofile == 0.28 04:41:50 INFO - mozrunner == 6.13 04:41:50 INFO - mozscreenshot == 0.1 04:41:50 INFO - mozsystemmonitor == 0.3 04:41:50 INFO - moztest == 0.7 04:41:50 INFO - mozversion == 1.4 04:41:50 INFO - psutil == 3.1.1 04:41:50 INFO - requests == 1.2.3 04:41:50 INFO - wsgiref == 0.1.2 04:41:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:41:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 04:41:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:41:50 INFO - Using env: {'DISPLAY': ':0', 04:41:50 INFO - 'HOME': '/home/cltbld', 04:41:50 INFO - 'LANG': 'en_US.UTF-8', 04:41:50 INFO - 'LANGUAGE': 'en_US:en', 04:41:50 INFO - 'LOGNAME': 'cltbld', 04:41:50 INFO - 'MAIL': '/var/mail/cltbld', 04:41:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:50 INFO - 'MOZ_NO_REMOTE': '1', 04:41:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:50 INFO - 'NO_EM_RESTART': '1', 04:41:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:50 INFO - 'PWD': '/builds/slave/test', 04:41:50 INFO - 'SHELL': '/bin/bash', 04:41:50 INFO - 'SHLVL': '1', 04:41:50 INFO - 'TERM': 'linux', 04:41:50 INFO - 'TMOUT': '86400', 04:41:50 INFO - 'USER': 'cltbld', 04:41:50 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:50 INFO - '_': '/tools/buildbot/bin/python'} 04:41:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:41:50 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:41:50 INFO - Cleaning up... 04:41:50 INFO - Return code: 0 04:41:50 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:41:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:41:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:41:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:41:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:41:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f066c560f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b238a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2bf0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:41:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 04:41:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:41:51 INFO - Using env: {'DISPLAY': ':0', 04:41:51 INFO - 'HOME': '/home/cltbld', 04:41:51 INFO - 'LANG': 'en_US.UTF-8', 04:41:51 INFO - 'LANGUAGE': 'en_US:en', 04:41:51 INFO - 'LOGNAME': 'cltbld', 04:41:51 INFO - 'MAIL': '/var/mail/cltbld', 04:41:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:41:51 INFO - 'MOZ_NO_REMOTE': '1', 04:41:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:41:51 INFO - 'NO_EM_RESTART': '1', 04:41:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:41:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:41:51 INFO - 'PWD': '/builds/slave/test', 04:41:51 INFO - 'SHELL': '/bin/bash', 04:41:51 INFO - 'SHLVL': '1', 04:41:51 INFO - 'TERM': 'linux', 04:41:51 INFO - 'TMOUT': '86400', 04:41:51 INFO - 'USER': 'cltbld', 04:41:51 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:41:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:41:51 INFO - '_': '/tools/buildbot/bin/python'} 04:41:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:41:51 INFO - Cleaning up... 04:41:51 INFO - Return code: 0 04:41:51 INFO - Running post-action listener: _resource_record_post_action 04:41:51 INFO - Running post-action listener: _start_resource_monitoring 04:41:51 INFO - Starting resource monitoring. 04:41:51 INFO - [mozharness: 2016-11-15 12:41:51.260592Z] Finished create-virtualenv step (success) 04:41:51 INFO - [mozharness: 2016-11-15 12:41:51.261110Z] Running install step. 04:41:51 INFO - Running pre-action listener: _resource_record_pre_action 04:41:51 INFO - Running main action method: install 04:41:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:41:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:41:51 INFO - Reading from file tmpfile_stdout 04:41:51 INFO - Detecting whether we're running mozinstall >=1.0... 04:41:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:41:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:41:51 INFO - Reading from file tmpfile_stdout 04:41:51 INFO - Output received: 04:41:51 INFO - Usage: mozinstall [options] installer 04:41:51 INFO - Options: 04:41:51 INFO - -h, --help show this help message and exit 04:41:51 INFO - -d DEST, --destination=DEST 04:41:51 INFO - Directory to install application into. [default: 04:41:51 INFO - "/builds/slave/test"] 04:41:51 INFO - --app=APP Application being installed. [default: firefox] 04:41:51 INFO - mkdir: /builds/slave/test/build/application 04:41:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 04:41:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 04:42:07 INFO - Reading from file tmpfile_stdout 04:42:07 INFO - Output received: 04:42:07 INFO - /builds/slave/test/build/application/firefox/firefox 04:42:07 INFO - Running post-action listener: _resource_record_post_action 04:42:07 INFO - [mozharness: 2016-11-15 12:42:07.620756Z] Finished install step (success) 04:42:07 INFO - [mozharness: 2016-11-15 12:42:07.621068Z] Running run-tests step. 04:42:07 INFO - Running pre-action listener: _resource_record_pre_action 04:42:07 INFO - Running main action method: run_tests 04:42:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:42:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:42:07 INFO - Python 2.7.3 04:42:07 INFO - Return code: 0 04:42:07 INFO - grabbing minidump binary from tooltool 04:42:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:42:07 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2bedf60>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2beed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2bef1d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:42:07 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 04:42:07 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 04:42:07 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 04:42:07 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:42:07 INFO - Return code: 0 04:42:07 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:42:07 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:42:07 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:42:07 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:42:07 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:42:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-047', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 04:42:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-047 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 04:42:07 INFO - Using env: {'DISPLAY': ':0', 04:42:07 INFO - 'HOME': '/home/cltbld', 04:42:07 INFO - 'LANG': 'en_US.UTF-8', 04:42:07 INFO - 'LANGUAGE': 'en_US:en', 04:42:07 INFO - 'LOGNAME': 'cltbld', 04:42:07 INFO - 'MAIL': '/var/mail/cltbld', 04:42:07 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:42:07 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:42:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:42:07 INFO - 'MOZ_NO_REMOTE': '1', 04:42:07 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:42:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:42:07 INFO - 'NO_EM_RESTART': '1', 04:42:07 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:42:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:42:07 INFO - 'PWD': '/builds/slave/test', 04:42:07 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:42:07 INFO - 'SHELL': '/bin/bash', 04:42:07 INFO - 'SHLVL': '1', 04:42:07 INFO - 'TERM': 'linux', 04:42:07 INFO - 'TMOUT': '86400', 04:42:07 INFO - 'USER': 'cltbld', 04:42:07 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240', 04:42:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:42:07 INFO - '_': '/tools/buildbot/bin/python'} 04:42:07 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-047', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 04:42:07 INFO - mozversion application_buildid: 20161115032613 04:42:07 INFO - mozversion application_changeset: 85a9d908e91a7071bbb1f554b275fb1b4e796e34 04:42:07 INFO - mozversion application_display_name: Nightly 04:42:07 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:42:07 INFO - mozversion application_name: Firefox 04:42:07 INFO - mozversion application_remotingname: firefox 04:42:07 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:42:07 INFO - mozversion application_vendor: Mozilla 04:42:07 INFO - mozversion application_version: 53.0a1 04:42:07 INFO - mozversion platform_buildid: 20161115032613 04:42:07 INFO - mozversion platform_changeset: 85a9d908e91a7071bbb1f554b275fb1b4e796e34 04:42:07 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:42:07 INFO - mozversion platform_version: 53.0a1 04:42:07 INFO - using testdate: 1479213727 04:42:07 INFO - actual date: 1479213727 04:42:07 INFO - starting webserver on 'localhost:38807' 04:42:07 INFO - SUITE-START | Running 2 tests 04:42:07 INFO - TEST-START | dromaeo_css 04:42:07 INFO - operating with platform_type : linux_ 04:42:07 INFO - Initialising browser for dromaeo_css test... 04:42:07 INFO - TEST-INFO | started process 14424 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdeBUB8/profile http://localhost:38807/getInfo.html) 04:42:12 INFO - PROCESS | 14424 | __metrics Screen width/height:1600/1200 04:42:12 INFO - PROCESS | 14424 | colorDepth:24 04:42:12 INFO - PROCESS | 14424 | Browser inner width/height: 1024/697 04:42:12 INFO - PROCESS | 14424 | __metrics 04:42:12 INFO - PROCESS | 14424 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 04:42:12 INFO - PROCESS | 14424 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:42:13 INFO - PROCESS | 14424 | console.error: PushService: 04:42:13 INFO - PROCESS | 14424 | stateChangeProcessEnqueue: Error transitioning state 04:42:13 INFO - PROCESS | 14424 | UnknownError 04:42:14 INFO - TEST-INFO | 14424: exit 0 04:42:14 INFO - Browser initialized. 04:42:14 INFO - Running cycle 1/1 for dromaeo_css test... 04:42:14 INFO - TEST-INFO | started process 14505 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpdeBUB8/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:42:26 INFO - PROCESS | 14505 | RSS: Main: 174882816 04:42:26 INFO - PROCESS | 14505 | 04:43:18 INFO - PROCESS | 14505 | 1479213798071 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 04:45:31 INFO - PROCESS | 14505 | Cycle 1(1): loaded http://localhost:38807/tests/dromaeo/cssquery-dojo.html (next: http://localhost:38807/tests/dromaeo/cssquery-ext.html) 04:45:32 INFO - PROCESS | 14505 | RSS: Main: 324354048 04:45:32 INFO - PROCESS | 14505 | 04:48:35 INFO - PROCESS | 14505 | Cycle 1(1): loaded http://localhost:38807/tests/dromaeo/cssquery-ext.html (next: http://localhost:38807/tests/dromaeo/cssquery-jquery.html) 04:48:36 INFO - PROCESS | 14505 | RSS: Main: 279162880 04:48:36 INFO - PROCESS | 14505 | 04:51:38 INFO - PROCESS | 14505 | Cycle 1(1): loaded http://localhost:38807/tests/dromaeo/cssquery-jquery.html (next: http://localhost:38807/tests/dromaeo/cssquery-mootools.html) 04:51:39 INFO - PROCESS | 14505 | RSS: Main: 263454720 04:51:39 INFO - PROCESS | 14505 | 04:54:41 INFO - PROCESS | 14505 | Cycle 1(1): loaded http://localhost:38807/tests/dromaeo/cssquery-mootools.html (next: http://localhost:38807/tests/dromaeo/cssquery-prototype.html) 04:54:42 INFO - PROCESS | 14505 | RSS: Main: 220250112 04:54:42 INFO - PROCESS | 14505 | 04:57:45 INFO - PROCESS | 14505 | Cycle 1(1): loaded http://localhost:38807/tests/dromaeo/cssquery-prototype.html (next: http://localhost:38807/tests/dromaeo/cssquery-yui.html) 04:57:45 INFO - PROCESS | 14505 | RSS: Main: 221581312 04:57:45 INFO - PROCESS | 14505 | 05:00:48 INFO - PROCESS | 14505 | Cycle 1(1): loaded http://localhost:38807/tests/dromaeo/cssquery-yui.html (next: http://localhost:38807/tests/dromaeo/cssquery-dojo.html) 05:00:49 INFO - PROCESS | 14505 | RSS: Main: 312401920 05:00:49 INFO - PROCESS | 14505 | 05:00:49 INFO - PROCESS | 14505 | __start_tp_report 05:00:49 INFO - PROCESS | 14505 | _x_x_mozilla_page_load 05:00:49 INFO - PROCESS | 14505 | _x_x_mozilla_page_load_details 05:00:49 INFO - PROCESS | 14505 | |i|pagename|runs| 05:00:49 INFO - PROCESS | 14505 | |0;dojo.html;2572.459783445476;2593.533164030474;2617.947641047179;2629.4346715456186;2640.996421359884;4433.778311084449;4464.687471876961;4590.793414296356;4628.375169352141;4644.581987621118;4525.298578720295;4548.431446069241;4578.702384345015;4613.146567884944;4643.883902902429;4190.476190476191;4219.261629214875;4252.80862361193;4278.35824626307;4286.142771445723;3894.3768996960493;4266.7439953602725;4291.871243862689;4339.088791353804;4378.890527736816;4177.394277829698;4237.87286381409;4249.277622804131;4326.351047342892;4347.869563913072;4207.705460617758;4249.192653395876;4259.659227261812;4267;4269.786510674454;4211.810468528924;4229.471316085489;4266.509351424595;4318.611324980736;4324.783760811947;4605.677602567822;4642.883927901796;4648.3957085578995;4693.671442998992;4707.199776038082;4966.503349665005;4982.526659967333;4983.401991760976;4985.9252111218;5025.14572522672;4830.9275360869615;4901.436334821506;4906.313116163704;4924.039812236615;4997.05056039355;4650.186217411906;4679.110968915895;4683.695559788603;4726.314684370747;4728.432588089451;5096.694198348111;5099.980003999215;5106.080905437057;5106.4382917879;5152.92270615941;4645.953540464552;4654.86035418938;4895.632827537949;4902.240152776325;4945;4853.4418541868135;4909.410870695539;4969.105560999054;4985.825496107619;5065.189569668909;4858.902821943541;4866.46468888422;4888.6577939543895;4974.452810190876;5024.171011783015;4920.950790492121;4925.482824303468;4935.950640493621;4942.728149951788;4970;3991.082051128257;4041.393790931325;4084.0606660468256;4134.462519872397;4138.813753381105;3597.1366871950545;3607.206414588786;3612.1330880588994;3650;3651.8904432867057;4281.100968796588;4286.357046442996;4290;4322.178786030644;4338.501072376654;4812.446568644581;4855.5387238212315;4865.221564549655;4978.477259887732;4988.052270068675;4161.10536234711;4207.158568286355;4212.178625168124;4227.556106608823;4262.062346283813;4324.891877703082;4347.695661303742;4352.651787856964;4399.780010999501;4401.1417773534495;4479.507254202101;4618.445786505641;4631.861044168681;4632.02727427244;4668.5098064702715;4815.879603009953;4876.29293752411;4884.731339776346;4951.876203094807;4952.133376659142;4687.203175460112;4689.249720044776;4705.694129881546;4718.622510199107;4732.787024583971;4867.3915760529935;4914.2628605708;4914.483979182134;4918.114739346809;4957.82647607332;4784.665073444826;4848.587870031087;4923.384576927884;4950.183219768698;4985.900281994413;4838.564529192389;4843.2250839865455;4869.269609558594;4870.7808148632685;4891.31521586971;4802.567768900815;4841.927371089366;4843.321934929183;4845.152098382699;4874.878128046686;4612.354270402079;4665.323528088476;4733.148033353892;4793.161196790617;4815.759212039314;4871.464138944784;4925.21196608541;4939.728314942713;4968.205087186033;4972.105021096238;4647.372604698322;4791.856244312677;4816.15717249487;4860.1251774680895;4874.098291816025 05:00:49 INFO - PROCESS | 14505 | |1;ext.html;544.0424852260021;545.2938444714094;548.4597671293775;552.9004779139755;566.7336351914602;28013.299667508323;30966.690333096663;37268.81365593175;38916.80541597288;39147.41278880812;39919;40324.798376008155;40370;40371.59628403715;40375.19249615006;7555.773326800205;7619.733309334174;7679.808004799869;7710.190430004853;7711.845763084735;7464.216257292987;7524.699012039512;7542.886856697154;7543.24567543244;7551.660175292125;7565.508241964255;7595.544267343949;7608.923910760905;7609.315161635452;7710.113336966237;7603.239676032353;7605.125410577743;7617.238276172394;7659.885101723478;7664.041994750656;7452.403807695371;7523.699052037912;7525.134609519921;7526.473146879721;7532.322091011781;37442.81278593617;37927;37933.81033094844;37958;37969.24061518754;2874.6694130175088;2972.5986991756054;2974.3605124898036;2998.34036511967;3112.4864397374404;28222.85888570544;28290;28409.289767755763;28743.85628071867;29902.252443688863;3228.8547015384365;3350.7602187190896;3429.554157959474;3497.7201823854284;3535.9469607955903;241651;243121;243343;243391;243825;32153.51769723456;33240.66759332376;33310.83344583261;33367.66632333694;53747.73126134344;32456.188595285308;32590.837045815093;32623.347533049207;32649.347013059607;32668.346633067682;12556.623301300975;12729.427175777113;12730.045246606542;12741.872581274069;12771.744565108645;10475.266731328733;10615.84076238857;10622.097121744739;10622.20333474977;10685.893141068489;7522.924770752223;7605.581693006827;7609.6575654095695;7642;7709.653065612061;2963.777716671258;2986.68639792823;3047.1467988963127;3049.2986613079115;3057.5107982722657;805.2269820971816;824.5629816197425;848.6562942008496;860.3891237221643;919.0396036142247;26973.730262697514;27690.723092768814;27725.306867328076;27822;27975.15354828455;762.3024932187097;892.7768057985504;907.0929070929071;920.8756817829641;938.9624415023322;13627.523036693668;14088.71822563543;14196.85803141976;14475.565733028026;14501.709965800625;352383;354829;355668;355690;355839;47501.52498474971;47917.520824792;47966.5203347969;47969.28046079312;47979.5202047975;1018.1701912941078;1050.985798704254;1133.0255979857482;1138.9031932285682;1153.4924633161381;25085.749142508343;28472.715272847006;28699.856500717364;28733;29487.410251794416;39744.20511589694;40152.79923600363;40180.1963960725;40305.395419069326;40312.79843600763;281843;283942;285622;286067;287747;22944.4263893404;23874.283771486884;24357.26928192157;24765;25627.487450251265;40355.19289614133;40492;40563.797181013906;40628;41433;34449.65550344464;35128.29743405169;35368.46947295741;35420.82289588536;35422.64577354193;34587.654123458444;34747.82626086853;34790.30419391547;35051;35321.116972075906;34911;34947.30105397827;36244.27511449703;36913;37491.62508374881;33863.49204761881;37456.81271593625;37597.43603845999;37639.43540846944;37728.62271377251;28996.27509312284;29947.550786737782;30348.544771827997;30574.84712576423;30655.54016689707 05:00:49 INFO - PROCESS | 14505 | |2;jquery.html;342.68301820815736;345.78906866811224;367.68195510883083;367.89698884312395;380.5680552572829;12423.254604723723;13479.79780303295;15272.16003119828;16580.75128873068;16686.916565417156;15689.686206275868;15841.287142078605;15991.520254392386;15999.360025598962;16083.195840207973;4874.366332376786;4882.56056954874;5032.949670503303;5053.949460505385;5066.493350664941;4917.950820491803;4975.278584605248;5086.415062267831;5267.051930652481;5294.867628309304;5350.5452036576935;5350.598705097113;5353.277307563488;5357.705326207057;5361.892762144755;5221.425643179247;5238.345206849144;5267.5259226669405;5293.947060529384;5327.866803329909;5128.820491282787;5140.280360749498;5144.819931302386;5154.278401023822;5158.509941555546;10968.890311096866;17780.733289000676;18166.27334906602;18420.907895460572;18517.907410462994;1721.8622510199154;1786.3926265069808;1991.9302824401077;2055.198472595689;2328.429534763977;8232.217939295757;8247.463914845515;8394.748157555283;8652.740417787476;8781;1655.3130450862877;1714.5426387570465;1724.6292047209786;1749.6413235286736;1818.0182701341391;66802.3319766801;67374.3262567373;67545;68554;69212.30787692108;9720.270979676552;9744.464054477072;9786.266030047633;10040;10101.898981010243;13597.796033059512;13615.931920340336;13629.114107582975;13632.454701812016;13634.52279170244;6491.902621460682;6507.8698426031215;6630.569013014138;6703.363180497845;6710.496712746563;6032.698365081728;6071.908921366183;6138.232720909887;6218.5647004710145;6250.6874656267;4223.21870453967;4239.173361194599;4263.936040959388;4347.152305300499;4357.455318085239;1761.7885853697637;1806.3717291341068;1827.7532533108126;1851.6111616560672;1874.4189301316635;729.9489035767446;795.6857041468587;816.5917041479261;861.9094995025557;867.6399294292924;15634.296456659478;16095.356185752438;16369.508914732578;16426.83573164277;17111.14444277806;840.1766269056359;847.3898792869124;853.3940901959554;855.5465603230298;896.3591032411857;8892.777680558038;9100.408473449204;9326.860097098548;9429.622815087458;9549.809003819884;352798;355348;359130;360465;361540;71827.64086179536;73489.26510734824;74079.25920740831;75402;76286.23713762902;789.5144486140982;810.562296359959;812.7642983534708;815.4862436664863;815.963281652327;14386.640333991734;14562.563123106323;14584;14606.488772892897;15166.165860877758;35382.29235415226;35958.64041359553;37020.814895925345;37027.07432314214;37177.814110930354;42999;44901;49128.508714912394;50533.74733126311;50831.74584127056;6230.748312773515;6712;6736.966315168393;6802.591844489347;6933.826654333682;7980.4812687175145;10234.33476824004;10324.328918620266;10810.081143102925;10868.565257389615;9111.453312801254;9482.905170948477;9567.9043209567;9663.178629816544;9692.9030709692;8310.127436619068;8349.874751878606;8645.870311945451;8669.91330086691;8942.150495702897;8986.68546600866;9052.773680658036;9056.683016094668;9057.728268151966;9446.480443575394;6353.745850165941;6534.8366290843105;6677.9332206679255;6750.426213771884;7313.414926805949;8920.910790892009;9027.819443611223;9048.366614336934;9058.773530661787;9434.48110353937 05:00:49 INFO - PROCESS | 14505 | |3;mootools.html;1220.3227208899068;1315.8486774020987;1357.9456821727128;1401.9299035048246;1642.4497793239273;5665.660060396379;6244.781432649858;6510.479161667073;6515.250746164181;6720.495962802785;6622.6357550334715;6686.4316533094625;6696.933030669692;6697.464202863772;6698.095757072793;1952.882827030379;1979.6931475621302;1979.9703004454946;1981.1580078466593;1981.7621885373703;1967.9901600491978;2035.7760646328893;2036.063410831012;2037.0833125093693;2039.3270220827092;1957.1388589020785;1977.4067779666043;1996.341207401554;1996.880187188766;1999.8300144487737;1977.0806574942649;1998.6302534031252;1998.9200431982704;1999.6100760351737;2001.3095482058666;1957.1779852461857;1994.9601007979759;1997.0713618167622;1997.121266642687;1997.8901160436171;6395.456386207178;6479;6525.347465253484;6550.246721626979;6574.145361103074;4001.279769641463;4180.226658068267;4180.874573762761;4183.853565125206;4192.371144328345;2528.582783840664;2658.003248781707;2708.8374697518016;2711.18664400679;2714.267147870064;875.1817051057282;894.1326912894482;894.7807787092204;1679.5465224389347;1699.6260822619004;8629.180227878403;8643.17889800468;8676.913230867674;8694.652213911437;8696.565171741388;3286.8824599636237;3546.6453354664327;3635.2911182319194;3637.618050104754;3651.1419816343137;6948.861022779516;6949.791506254821;6954;6954.826129346807;6964.965175174092;4073.124278280184;4074.2869997750277;4074.6740260779065;4075.918481630351;4078.0824314529586;3339.0984434203115;3460.7750496217664;3606.4229723244157;3761.3793724035777;3808.067023579241;3098.070578826343;3150.3699260147605;3242.5622540957143;3245.837708114585;3265.1837040739815;1056.1814593689799;1085.7177133945231;1089.4171618184234;1100;1105.5467258424007;709.5033476566424;725.1769241910364;731.4294850016995;747.3460721868365;755.199488542147;4256.574342565718;4298.935515967263;4363.4109395231235;4431.601155895984;4500.279955207151;358.2226568346694;360.1644185489639;362.5250921293115;366.79276208942395;368.1201927393532;2984.358362951976;2987.9701202988126;2991.3718119194778;2996.1910284223572;3077.430675325027;7195.388391986635;7614;7839.725609603751;7931.801704957307;7932.325752311002;7488.363489103487;7605.23947605235;7615.16233214346;7615.504992175491;7616.428767842434;6088.817335479943;6258.186435763413;6266.310705822447;6268.811935641938;6270.090836828635;4456;4509.661775366926;4552.385427967314;4610.953890461053;4778;7085.574865508086;7178.497505174588;7297.489175757646;7400.222976587381;7499;7246.782596522113;7483.251674832473;7506.849863002819;7506.9249307506225;7508.324250817453;5591.6365436246515;5788.450097240755;5835.912461312999;5841.912371314519;5856.765729370777;5699.5155411790465;5891.23413956183;6151.477124444473;6351.841203969938;6355.968220159055;5912.852178695567;5941.346451890202;5945.197398351167;5953.374895636069;5989.850253743517;5850.268716410449;5852.736626851717;5892.438503796412;5929.644221346561;5962.880742385215;5315.9468405317;5359.892802144013;5385.434529374359;5389.27244821944;5398.487143721497;3892.9805350973065;3927.587603301612;3929.528456585228;3984.7808370539897;4013.9397909030804;3822.6177382261553;3831.885043448701;3849.7690138591774;3919.92160156801;3934.4295077214215 05:00:49 INFO - PROCESS | 14505 | |4;prototype.html;276.34919763955884;281.0500508282007;285.6372407043056;290.90184553311246;291.96788353281147;4731.266653668683;4749.928751068728;4768.976155119224;4782.976085119578;4794.664373493857;4679.929801052978;4710.081534100852;4711.539422778932;4730.668853180278;4743.928841067387;3487.8779242726573;3566.144125409909;3607.2424790793966;3669.4128939369707;3678.485012098295;3692.833822477995;3694.3350196964534;3699.889003329891;3706.703463722909;3711.0536813112617;3657.4330978698213;3664.7617904836234;3668.9816550917208;3670.541182352206;3702.759320644163;3450.8949540780104;3540.6545512705266;3556.1109722569227;3633.9461556148685;3660.4143337066207;3221.743520027191;3223.4036703209745;3235.2397186661115;3237.4496335623003;3237.854296556637;4550.453945526558;4565.196747284837;4581.244094724367;4589.265717485219;4590.02628869586;3881.2237552489332;4096.160287141129;4144.254034273829;4152.27335216339;4161.605862036222;4856.514348565115;4873.610111191097;4874.585660218886;4881.170201065792;4882.654437550583;3418.538497302857;3427.326685185559;3434.6050204226335;3435.9828200859088;3441.638627944055;5048.368953880765;5140.974295128501;5182.455842136596;5185.844424667266;5196.558292545138;3512.7892326459983;3514.332276867387;3517.3141237458963;3525.7531972761662;3538.6815186633326;3553.342631613108;3556.3776339141064;3557.928841423157;3565.1800085979853;3565.4117070683565;4087.7547347159266;4111.527174374925;4115;4117.1765646870745;4117.814698338582;4724.669273150916;4878.463369029404;4945.703257804544;4965.577925876269;4970.229614409773;1188.3464094747853;1200.7598480303975;1203.2720204276286;1204.1811568133578;1206.9680423238005;735.9227281135511;777.9222077792175;813.7965508622844;827.6606591297539;828.5153185386496;4150.169966006751;4279.293916503804;4388.5830846069575;4400.251957167289;4400.757958312323;5039.740064983754;5047.2429135629945;5049.267856160836;5076.568491678248;5089.262057001714;4405.31717583775;4405.603495685404;4405.691601587858;4417.116576684676;4417.690761646654;2456.82802203844;2586.5602847515966;2598.246508512548;2618.528664840309;2627.6584044074148;4641.86074417768;4644.535546445329;4660.231061874752;4670.626349892001;4672.813087476463;5032.521910418504;5042.302368232978;5043.470435604282;5052.722100284446;5080.272707279469;4390.6630960470275;4623.4228114166735;4636.953630463652;4659.207934651117;4664.720116793003;4885.780139893643;4897;4901.215805471107;4918.213085906238;4923.655344125877;4745.552606455064;4754.21555443348;4768.9523104768505;4819.180739274402;4844.781984810622;4429.623482004065;4591.563801438858;4611.5619016193405;4614.861554153381;4633.096546173464;3353.849076791599;3370.7416031259604;3377.3920694275266;3390.8643654254543;3399.320135972766;4880.463149053672;4922.310876477224;4930.630202734881;4942.703437793743;4943.431505376928;4647.9767601161775;4791.0178413425865;4830.082284365959;4933.55597996182;4993.226049962262;4919.704817710805;4951.579115775199;4960.305557222064;4984.679060049018;4987.625928055338;4886.413630364379;4896.877578060435;4912.582430493448;4916.287138364845;4937.432195297587;4859.489753575824;4976.2038073908;4994.550490455877;5033.320501732365;5049;4856.660033797601;4888.335856958038;4893.853184404474;4896.877578060435;4917.959046995456 05:00:49 INFO - PROCESS | 14505 | |5;yui.html;605.5882000239841;606.6814922165862;621.6145989486519;633.2938773267805;726.3172617739325;13168.078234523588;13791.172529648227;13793.172409655428;13794.65513362164;13805.447782088717;12485.68785780356;12536.686582835433;12567.183133096343;12601.62195134145;12647.494100236003;600.9459148676618;616.3866952382385;739.5858319341173;762.5005621318018;764.1250767870785;732.765515035189;758.1432980731765;759.3242014607005;760.6424980259269;761.5126319155745;794.3446656508374;797.0554892452462;797.0674311056079;797.6769408389612;798.6845196147518;626.9310375858652;789.3290702902544;792.6987744657051;793.095870707394;793.2939683681528;471.02262804680083;554.2268535393144;561.1778744139855;570.7745440551;572.461885827321;12134.878651213463;12236.755264894742;12251.081168912368;12313.26120432777;12397.194182378116;9357.953210233973;9692.127708506268;9760.90239097607;9965.70102896907;9970.850437243447;8612.440191387539;9010;10941.301665176205;11222.551097956071;11229;3169.350283191963;3186.0919637903085;3271.4438545447333;3363.764536482447;3996.540397854255;50088.74778130539;50184.74907625438;50236.497635023545;50409;51374.743126284506;9663.420194788336;9710.563024663907;9851.261155413373;9858.408495490294;9930.304878658424;16902.239399227063;16917.7462338065;16919.492415227563;17011.489655310113;17047.31810727582;6178.62928224308;6198.194234749544;6280.811575652647;6348.650824204713;6392.680365981682;3155.4339716488435;3178.4278829810855;3202.5676533668125;3320.7177389921644;3400.795952242873;2723.400851812598;2926.3854590536225;2966.347403571211;2989.6561895381874;2997.1607949774098;505.2850216943058;509.1039770004818;510.19898758948835;512.4465577176715;513.2301547678483;508.07276719985435;556.6332124483502;587.4448646029462;588.1002066837746;593.9495142912814;7618.276263754934;7890;8102.51384916895;8209.055958564722;8856.8671469928;491.50112635674816;504.5938019893947;569.9114690940366;577.924869766936;623.43579060949;3714.108613932691;3865.3622152344547;3896;3944.526656801202;4108.5275193352545;52795.47204527982;55519;55616.72191639097;63034.684826575576;64815.35184648188;35650;42122.57877421186;54649;56694;57371.42628573744;50275.24587131196;50416.747916260916;51176.74411627918;53866.46133538614;56656.433435665116;7866.803329916798;8069.515829050276;8166.4283500154415;8194.34445244391;8441.746747597583;36516;37686.81156594199;37696;38119.618803812715;38367.808160959015;44001.55998440103;46955.53044469511;47777.522224777305;49188.75405622949;51605.741971289906;10847.620333288298;10862.248696947134;10898.18263630215;11070.667879963614;11405.543778248777;11124.165687573626;11624.593139240085;11627.709307267385;11677.824832627348;11811.350375729417;10597;11029.805461359896;11079;11677.474513647076;11691.532338706696;9573.904260957579;9853.113219810251;9912.14192611167;10235.897641023494;10494.632687856194;10778.137748979905;10965.780684386427;11177.497012634289;11629.651110466699;11643.88356116462;8521.403501754818;8578;8755;8862.246709029547;9024.36829421934;8017.799555011172;8259.752207433787;8390.28682561989;8651.95674021626;8700.347473939353 05:00:49 INFO - PROCESS | 14505 | __end_tp_report 05:00:49 INFO - PROCESS | 14505 | __start_cc_report 05:00:49 INFO - PROCESS | 14505 | _x_x_mozilla_cycle_collect,1609 05:00:49 INFO - PROCESS | 14505 | __end_cc_report 05:00:49 INFO - PROCESS | 14505 | __startTimestamp1479214849120__endTimestamp 05:00:49 INFO - PROCESS | 14505 | 05:00:49 INFO - PROCESS | 14505 | ------- Summary: start ------- 05:00:49 INFO - PROCESS | 14505 | Number of tests: 6 05:00:49 INFO - PROCESS | 14505 | 05:00:49 INFO - PROCESS | 14505 | [#0] dojo.html Cycles:165 Average:4565.89 Median:4689.25 stddev:485.88 (10.4%) stddev-sans-first:461.52 05:00:49 INFO - PROCESS | 14505 | Values: 2572.5 2593.5 2617.9 2629.4 2641.0 4433.8 4464.7 4590.8 4628.4 4644.6 4525.3 4548.4 4578.7 4613.1 4643.9 4190.5 4219.3 4252.8 4278.4 4286.1 3894.4 4266.7 4291.9 4339.1 4378.9 4177.4 4237.9 4249.3 4326.4 4347.9 4207.7 4249.2 4259.7 4267.0 4269.8 4211.8 4229.5 4266.5 4318.6 4324.8 4605.7 4642.9 4648.4 4693.7 4707.2 4966.5 4982.5 4983.4 4985.9 5025.1 4830.9 4901.4 4906.3 4924.0 4997.1 4650.2 4679.1 4683.7 4726.3 4728.4 5096.7 5100.0 5106.1 5106.4 5152.9 4646.0 4654.9 4895.6 4902.2 4945.0 4853.4 4909.4 4969.1 4985.8 5065.2 4858.9 4866.5 4888.7 4974.5 5024.2 4921.0 4925.5 4936.0 4942.7 4970.0 3991.1 4041.4 4084.1 4134.5 4138.8 3597.1 3607.2 3612.1 3650.0 3651.9 4281.1 4286.4 4290.0 4322.2 4338.5 4812.4 4855.5 4865.2 4978.5 4988.1 4161.1 4207.2 4212.2 4227.6 4262.1 4324.9 4347.7 4352.7 4399.8 4401.1 4479.5 4618.4 4631.9 4632.0 4668.5 4815.9 4876.3 4884.7 4951.9 4952.1 4687.2 4689.2 4705.7 4718.6 4732.8 4867.4 4914.3 4914.5 4918.1 4957.8 4784.7 4848.6 4923.4 4950.2 4985.9 4838.6 4843.2 4869.3 4870.8 4891.3 4802.6 4841.9 4843.3 4845.2 4874.9 4612.4 4665.3 4733.1 4793.2 4815.8 4871.5 4925.2 4939.7 4968.2 4972.1 4647.4 4791.9 4816.2 4860.1 4874.1 05:00:49 INFO - PROCESS | 14505 | 05:00:49 INFO - PROCESS | 14505 | [#1] ext.html Cycles:180 Average:43671.26 Median:19428.53 stddev:78362.08 (403.3%) stddev-sans-first:78515.01 05:00:49 INFO - PROCESS | 14505 | Values: 544.0 545.3 548.5 552.9 566.7 28013.3 30966.7 37268.8 38916.8 39147.4 39919.0 40324.8 40370.0 40371.6 40375.2 7555.8 7619.7 7679.8 7710.2 7711.8 7464.2 7524.7 7542.9 7543.2 7551.7 7565.5 7595.5 7608.9 7609.3 7710.1 7603.2 7605.1 7617.2 7659.9 7664.0 7452.4 7523.7 7525.1 7526.5 7532.3 37442.8 37927.0 37933.8 37958.0 37969.2 2874.7 2972.6 2974.4 2998.3 3112.5 28222.9 28290.0 28409.3 28743.9 29902.3 3228.9 3350.8 3429.6 3497.7 3535.9 241651.0 243121.0 243343.0 243391.0 243825.0 32153.5 33240.7 33310.8 33367.7 53747.7 32456.2 32590.8 32623.3 32649.3 32668.3 12556.6 12729.4 12730.0 12741.9 12771.7 10475.3 10615.8 10622.1 10622.2 10685.9 7522.9 7605.6 7609.7 7642.0 7709.7 2963.8 2986.7 3047.1 3049.3 3057.5 805.2 824.6 848.7 860.4 919.0 26973.7 27690.7 27725.3 27822.0 27975.2 762.3 892.8 907.1 920.9 939.0 13627.5 14088.7 14196.9 14475.6 14501.7 352383.0 354829.0 355668.0 355690.0 355839.0 47501.5 47917.5 47966.5 47969.3 47979.5 1018.2 1051.0 1133.0 1138.9 1153.5 25085.7 28472.7 28699.9 28733.0 29487.4 39744.2 40152.8 40180.2 40305.4 40312.8 281843.0 283942.0 285622.0 286067.0 287747.0 22944.4 23874.3 24357.3 24765.0 25627.5 40355.2 40492.0 40563.8 40628.0 41433.0 34449.7 35128.3 35368.5 35420.8 35422.6 34587.7 34747.8 34790.3 35051.0 35321.1 34911.0 34947.3 36244.3 36913.0 37491.6 33863.5 37456.8 37597.4 37639.4 37728.6 28996.3 29947.6 30348.5 30574.8 30655.5 05:00:49 INFO - PROCESS | 14505 | 05:00:49 INFO - PROCESS | 14505 | [#2] jquery.html Cycles:180 Average:22638.51 Median:5252.70 stddev:59283.11 (1128.6%) stddev-sans-first:59425.78 05:00:49 INFO - PROCESS | 14505 | Values: 342.7 345.8 367.7 367.9 380.6 12423.3 13479.8 15272.2 16580.8 16686.9 15689.7 15841.3 15991.5 15999.4 16083.2 4874.4 4882.6 5032.9 5053.9 5066.5 4918.0 4975.3 5086.4 5267.1 5294.9 5350.5 5350.6 5353.3 5357.7 5361.9 5221.4 5238.3 5267.5 5293.9 5327.9 5128.8 5140.3 5144.8 5154.3 5158.5 10968.9 17780.7 18166.3 18420.9 18517.9 1721.9 1786.4 1991.9 2055.2 2328.4 8232.2 8247.5 8394.7 8652.7 8781.0 1655.3 1714.5 1724.6 1749.6 1818.0 66802.3 67374.3 67545.0 68554.0 69212.3 9720.3 9744.5 9786.3 10040.0 10101.9 13597.8 13615.9 13629.1 13632.5 13634.5 6491.9 6507.9 6630.6 6703.4 6710.5 6032.7 6071.9 6138.2 6218.6 6250.7 4223.2 4239.2 4263.9 4347.2 4357.5 1761.8 1806.4 1827.8 1851.6 1874.4 729.9 795.7 816.6 861.9 867.6 15634.3 16095.4 16369.5 16426.8 17111.1 840.2 847.4 853.4 855.5 896.4 8892.8 9100.4 9326.9 9429.6 9549.8 352798.0 355348.0 359130.0 360465.0 361540.0 71827.6 73489.3 74079.3 75402.0 76286.2 789.5 810.6 812.8 815.5 816.0 14386.6 14562.6 14584.0 14606.5 15166.2 35382.3 35958.6 37020.8 37027.1 37177.8 42999.0 44901.0 49128.5 50533.7 50831.7 6230.7 6712.0 6737.0 6802.6 6933.8 7980.5 10234.3 10324.3 10810.1 10868.6 9111.5 9482.9 9567.9 9663.2 9692.9 8310.1 8349.9 8645.9 8669.9 8942.2 8986.7 9052.8 9056.7 9057.7 9446.5 6353.7 6534.8 6677.9 6750.4 7313.4 8920.9 9027.8 9048.4 9058.8 9434.5 05:00:49 INFO - PROCESS | 14505 | 05:00:49 INFO - PROCESS | 14505 | [#3] mootools.html Cycles:180 Average:4340.41 Median:4443.80 stddev:2293.96 (51.6%) stddev-sans-first:2288.41 05:00:49 INFO - PROCESS | 14505 | Values: 1220.3 1315.8 1357.9 1401.9 1642.4 5665.7 6244.8 6510.5 6515.3 6720.5 6622.6 6686.4 6696.9 6697.5 6698.1 1952.9 1979.7 1980.0 1981.2 1981.8 1968.0 2035.8 2036.1 2037.1 2039.3 1957.1 1977.4 1996.3 1996.9 1999.8 1977.1 1998.6 1998.9 1999.6 2001.3 1957.2 1995.0 1997.1 1997.1 1997.9 6395.5 6479.0 6525.3 6550.2 6574.1 4001.3 4180.2 4180.9 4183.9 4192.4 2528.6 2658.0 2708.8 2711.2 2714.3 875.2 894.1 894.8 1679.5 1699.6 8629.2 8643.2 8676.9 8694.7 8696.6 3286.9 3546.6 3635.3 3637.6 3651.1 6948.9 6949.8 6954.0 6954.8 6965.0 4073.1 4074.3 4074.7 4075.9 4078.1 3339.1 3460.8 3606.4 3761.4 3808.1 3098.1 3150.4 3242.6 3245.8 3265.2 1056.2 1085.7 1089.4 1100.0 1105.5 709.5 725.2 731.4 747.3 755.2 4256.6 4298.9 4363.4 4431.6 4500.3 358.2 360.2 362.5 366.8 368.1 2984.4 2988.0 2991.4 2996.2 3077.4 7195.4 7614.0 7839.7 7931.8 7932.3 7488.4 7605.2 7615.2 7615.5 7616.4 6088.8 6258.2 6266.3 6268.8 6270.1 4456.0 4509.7 4552.4 4611.0 4778.0 7085.6 7178.5 7297.5 7400.2 7499.0 7246.8 7483.3 7506.8 7506.9 7508.3 5591.6 5788.5 5835.9 5841.9 5856.8 5699.5 5891.2 6151.5 6351.8 6356.0 5912.9 5941.3 5945.2 5953.4 5989.9 5850.3 5852.7 5892.4 5929.6 5962.9 5315.9 5359.9 5385.4 5389.3 5398.5 3893.0 3927.6 3929.5 3984.8 4013.9 3822.6 3831.9 3849.8 3919.9 3934.4 05:00:49 INFO - PROCESS | 14505 | 05:00:49 INFO - PROCESS | 14505 | [#4] prototype.html Cycles:180 Average:4043.72 Median:4628.26 stddev:1189.70 (25.7%) stddev-sans-first:1158.94 05:00:49 INFO - PROCESS | 14505 | Values: 276.3 281.1 285.6 290.9 292.0 4731.3 4749.9 4769.0 4783.0 4794.7 4679.9 4710.1 4711.5 4730.7 4743.9 3487.9 3566.1 3607.2 3669.4 3678.5 3692.8 3694.3 3699.9 3706.7 3711.1 3657.4 3664.8 3669.0 3670.5 3702.8 3450.9 3540.7 3556.1 3633.9 3660.4 3221.7 3223.4 3235.2 3237.4 3237.9 4550.5 4565.2 4581.2 4589.3 4590.0 3881.2 4096.2 4144.3 4152.3 4161.6 4856.5 4873.6 4874.6 4881.2 4882.7 3418.5 3427.3 3434.6 3436.0 3441.6 5048.4 5141.0 5182.5 5185.8 5196.6 3512.8 3514.3 3517.3 3525.8 3538.7 3553.3 3556.4 3557.9 3565.2 3565.4 4087.8 4111.5 4115.0 4117.2 4117.8 4724.7 4878.5 4945.7 4965.6 4970.2 1188.3 1200.8 1203.3 1204.2 1207.0 735.9 777.9 813.8 827.7 828.5 4150.2 4279.3 4388.6 4400.3 4400.8 5039.7 5047.2 5049.3 5076.6 5089.3 4405.3 4405.6 4405.7 4417.1 4417.7 2456.8 2586.6 2598.2 2618.5 2627.7 4641.9 4644.5 4660.2 4670.6 4672.8 5032.5 5042.3 5043.5 5052.7 5080.3 4390.7 4623.4 4637.0 4659.2 4664.7 4885.8 4897.0 4901.2 4918.2 4923.7 4745.6 4754.2 4769.0 4819.2 4844.8 4429.6 4591.6 4611.6 4614.9 4633.1 3353.8 3370.7 3377.4 3390.9 3399.3 4880.5 4922.3 4930.6 4942.7 4943.4 4648.0 4791.0 4830.1 4933.6 4993.2 4919.7 4951.6 4960.3 4984.7 4987.6 4886.4 4896.9 4912.6 4916.3 4937.4 4859.5 4976.2 4994.6 5033.3 5049.0 4856.7 4888.3 4893.9 4896.9 4918.0 05:00:49 INFO - PROCESS | 14505 | 05:00:49 INFO - PROCESS | 14505 | [#5] yui.html Cycles:180 Average:13762.90 Median:512.84 stddev:16880.03 (3291.5%) stddev-sans-first:16898.47 05:00:49 INFO - PROCESS | 14505 | Values: 605.6 606.7 621.6 633.3 726.3 13168.1 13791.2 13793.2 13794.7 13805.4 12485.7 12536.7 12567.2 12601.6 12647.5 600.9 616.4 739.6 762.5 764.1 732.8 758.1 759.3 760.6 761.5 794.3 797.1 797.1 797.7 798.7 626.9 789.3 792.7 793.1 793.3 471.0 554.2 561.2 570.8 572.5 12134.9 12236.8 12251.1 12313.3 12397.2 9358.0 9692.1 9760.9 9965.7 9970.9 8612.4 9010.0 10941.3 11222.6 11229.0 3169.4 3186.1 3271.4 3363.8 3996.5 50088.7 50184.7 50236.5 50409.0 51374.7 9663.4 9710.6 9851.3 9858.4 9930.3 16902.2 16917.7 16919.5 17011.5 17047.3 6178.6 6198.2 6280.8 6348.7 6392.7 3155.4 3178.4 3202.6 3320.7 3400.8 2723.4 2926.4 2966.3 2989.7 2997.2 505.3 509.1 510.2 512.4 513.2 508.1 556.6 587.4 588.1 593.9 7618.3 7890.0 8102.5 8209.1 8856.9 491.5 504.6 569.9 577.9 623.4 3714.1 3865.4 3896.0 3944.5 4108.5 52795.5 55519.0 55616.7 63034.7 64815.4 35650.0 42122.6 54649.0 56694.0 57371.4 50275.2 50416.7 51176.7 53866.5 56656.4 7866.8 8069.5 8166.4 8194.3 8441.7 36516.0 37686.8 37696.0 38119.6 38367.8 44001.6 46955.5 47777.5 49188.8 51605.7 10847.6 10862.2 10898.2 11070.7 11405.5 11124.2 11624.6 11627.7 11677.8 11811.4 10597.0 11029.8 11079.0 11677.5 11691.5 9573.9 9853.1 9912.1 10235.9 10494.6 10778.1 10965.8 11177.5 11629.7 11643.9 8521.4 8578.0 8755.0 8862.2 9024.4 8017.8 8259.8 8390.3 8652.0 8700.3 05:00:49 INFO - PROCESS | 14505 | -------- Summary: end -------- 05:00:49 INFO - PROCESS | 14505 | 05:00:50 INFO - TEST-INFO | 14505: exit 0 05:00:50 INFO - TEST-OK | dromaeo_css | took 1122225ms 05:00:50 INFO - TEST-START | kraken 05:00:50 INFO - operating with platform_type : linux_ 05:00:50 INFO - Initialising browser for kraken test... 05:00:50 INFO - TEST-INFO | started process 14813 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp7GaF2j/profile http://localhost:38807/getInfo.html) 05:00:54 INFO - PROCESS | 14813 | __metrics Screen width/height:1600/1200 05:00:54 INFO - PROCESS | 14813 | colorDepth:24 05:00:54 INFO - PROCESS | 14813 | Browser inner width/height: 1024/697 05:00:54 INFO - PROCESS | 14813 | __metrics 05:00:54 INFO - PROCESS | 14813 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 05:00:54 INFO - PROCESS | 14813 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:00:55 INFO - PROCESS | 14813 | console.error: PushService: 05:00:55 INFO - PROCESS | 14813 | stateChangeProcessEnqueue: Error transitioning state 05:00:55 INFO - PROCESS | 14813 | UnknownError 05:00:56 INFO - TEST-INFO | 14813: exit 0 05:00:56 INFO - Browser initialized. 05:00:56 INFO - Running cycle 1/1 for kraken test... 05:00:56 INFO - TEST-INFO | started process 14898 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp7GaF2j/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:01:08 INFO - PROCESS | 14898 | RSS: Main: 174940160 05:01:08 INFO - PROCESS | 14898 | 05:01:11 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:38807/tests/kraken/driver.html?testName=audio-beat-detection) 05:01:12 INFO - PROCESS | 14898 | RSS: Main: 240295936 05:01:12 INFO - PROCESS | 14898 | 05:01:15 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:38807/tests/kraken/driver.html?testName=audio-dft) 05:01:15 INFO - PROCESS | 14898 | RSS: Main: 218079232 05:01:15 INFO - PROCESS | 14898 | 05:01:19 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:38807/tests/kraken/driver.html?testName=audio-fft) 05:01:19 INFO - PROCESS | 14898 | RSS: Main: 299741184 05:01:19 INFO - PROCESS | 14898 | 05:01:21 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:38807/tests/kraken/driver.html?testName=audio-oscillator) 05:01:22 INFO - PROCESS | 14898 | RSS: Main: 208900096 05:01:22 INFO - PROCESS | 14898 | 05:01:24 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:38807/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:01:25 INFO - PROCESS | 14898 | RSS: Main: 214560768 05:01:25 INFO - PROCESS | 14898 | 05:01:28 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:38807/tests/kraken/driver.html?testName=imaging-darkroom) 05:01:29 INFO - PROCESS | 14898 | RSS: Main: 254218240 05:01:29 INFO - PROCESS | 14898 | 05:01:32 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:38807/tests/kraken/driver.html?testName=imaging-desaturate) 05:01:33 INFO - PROCESS | 14898 | RSS: Main: 247996416 05:01:33 INFO - PROCESS | 14898 | 05:01:35 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:38807/tests/kraken/driver.html?testName=json-parse-financial) 05:01:36 INFO - PROCESS | 14898 | RSS: Main: 250638336 05:01:36 INFO - PROCESS | 14898 | 05:01:38 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:38807/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:01:38 INFO - PROCESS | 14898 | RSS: Main: 213835776 05:01:38 INFO - PROCESS | 14898 | 05:01:40 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:38807/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:01:41 INFO - PROCESS | 14898 | RSS: Main: 221618176 05:01:41 INFO - PROCESS | 14898 | 05:01:43 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:38807/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:01:44 INFO - PROCESS | 14898 | RSS: Main: 229867520 05:01:44 INFO - PROCESS | 14898 | 05:01:47 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:38807/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:01:47 INFO - PROCESS | 14898 | RSS: Main: 238411776 05:01:47 INFO - PROCESS | 14898 | 05:01:50 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:38807/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:01:51 INFO - PROCESS | 14898 | RSS: Main: 234991616 05:01:51 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | Cycle 1(1): loaded http://localhost:38807/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:38807/tests/kraken/driver.html?testName=ai-astar) 05:01:53 INFO - PROCESS | 14898 | RSS: Main: 285409280 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | __start_tp_report 05:01:53 INFO - PROCESS | 14898 | _x_x_mozilla_page_load 05:01:53 INFO - PROCESS | 14898 | _x_x_mozilla_page_load_details 05:01:53 INFO - PROCESS | 14898 | |i|pagename|runs| 05:01:53 INFO - PROCESS | 14898 | |0;ai-astar;109;117;117;122;116;117;116;116;118;116 05:01:53 INFO - PROCESS | 14898 | |1;audio-beat-detection;149;131;127;166;128;129;130;130;163;128 05:01:53 INFO - PROCESS | 14898 | |2;audio-dft;163;163;162;160;161;160;162;162;160;161 05:01:53 INFO - PROCESS | 14898 | |3;audio-fft;75;77;75;108;78;78;78;78;112;77 05:01:53 INFO - PROCESS | 14898 | |4;audio-oscillator;84;84;110;84;85;84;104;84;84;114 05:01:53 INFO - PROCESS | 14898 | |5;imaging-gaussian-blur;117;117;117;118;117;118;118;117;118;120 05:01:53 INFO - PROCESS | 14898 | |6;imaging-darkroom;147;147;147;146;146;146;146;147;145;146 05:01:53 INFO - PROCESS | 14898 | |7;imaging-desaturate;85;85;85;85;86;85;85;85;84;85 05:01:53 INFO - PROCESS | 14898 | |8;json-parse-financial;64;63;63;62;64;64;64;64;64;64 05:01:53 INFO - PROCESS | 14898 | |9;json-stringify-tinderbox;66;66;67;66;67;67;66;67;67;67 05:01:53 INFO - PROCESS | 14898 | |10;stanford-crypto-aes;86;84;83;91;85;84;84;86;83;84 05:01:53 INFO - PROCESS | 14898 | |11;stanford-crypto-ccm;146;152;141;144;144;142;141;140;192;140 05:01:53 INFO - PROCESS | 14898 | |12;stanford-crypto-pbkdf2;180;182;182;185;186;181;182;184;182;183 05:01:53 INFO - PROCESS | 14898 | |13;stanford-crypto-sha256-iterative;69;69;70;70;69;72;69;72;69;70 05:01:53 INFO - PROCESS | 14898 | __end_tp_report 05:01:53 INFO - PROCESS | 14898 | __start_cc_report 05:01:53 INFO - PROCESS | 14898 | _x_x_mozilla_cycle_collect,1946 05:01:53 INFO - PROCESS | 14898 | __end_cc_report 05:01:53 INFO - PROCESS | 14898 | __startTimestamp1479214913635__endTimestamp 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | ------- Summary: start ------- 05:01:53 INFO - PROCESS | 14898 | Number of tests: 14 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#0] ai-astar Cycles:10 Average:116.40 Median:117.00 stddev:3.17 (2.7%) stddev-sans-first:1.92 05:01:53 INFO - PROCESS | 14898 | Values: 109.0 117.0 117.0 122.0 116.0 117.0 116.0 116.0 118.0 116.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#1] audio-beat-detection Cycles:10 Average:138.10 Median:130.50 stddev:15.31 (11.7%) stddev-sans-first:15.72 05:01:53 INFO - PROCESS | 14898 | Values: 149.0 131.0 127.0 166.0 128.0 129.0 130.0 130.0 163.0 128.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#2] audio-dft Cycles:10 Average:161.40 Median:162.00 stddev:1.17 (0.7%) stddev-sans-first:1.09 05:01:53 INFO - PROCESS | 14898 | Values: 163.0 163.0 162.0 160.0 161.0 160.0 162.0 162.0 160.0 161.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#3] audio-fft Cycles:10 Average:83.60 Median:77.50 stddev:13.99 (18.1%) stddev-sans-first:14.49 05:01:53 INFO - PROCESS | 14898 | Values: 75.0 77.0 75.0 108.0 78.0 78.0 78.0 78.0 112.0 77.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#4] audio-oscillator Cycles:10 Average:91.70 Median:84.00 stddev:12.40 (14.8%) stddev-sans-first:12.84 05:01:53 INFO - PROCESS | 14898 | Values: 84.0 84.0 110.0 84.0 85.0 84.0 104.0 84.0 84.0 114.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#5] imaging-gaussian-blur Cycles:10 Average:117.70 Median:118.00 stddev:0.95 (0.8%) stddev-sans-first:0.97 05:01:53 INFO - PROCESS | 14898 | Values: 117.0 117.0 117.0 118.0 117.0 118.0 118.0 117.0 118.0 120.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#6] imaging-darkroom Cycles:10 Average:146.30 Median:146.50 stddev:0.67 (0.5%) stddev-sans-first:0.67 05:01:53 INFO - PROCESS | 14898 | Values: 147.0 147.0 147.0 146.0 146.0 146.0 146.0 147.0 145.0 146.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#7] imaging-desaturate Cycles:10 Average:85.00 Median:85.00 stddev:0.47 (0.6%) stddev-sans-first:0.50 05:01:53 INFO - PROCESS | 14898 | Values: 85.0 85.0 85.0 85.0 86.0 85.0 85.0 85.0 84.0 85.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#8] json-parse-financial Cycles:10 Average:63.60 Median:64.00 stddev:0.70 (1.1%) stddev-sans-first:0.73 05:01:53 INFO - PROCESS | 14898 | Values: 64.0 63.0 63.0 62.0 64.0 64.0 64.0 64.0 64.0 64.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#9] json-stringify-tinderbox Cycles:10 Average:66.60 Median:67.00 stddev:0.52 (0.8%) stddev-sans-first:0.50 05:01:53 INFO - PROCESS | 14898 | Values: 66.0 66.0 67.0 66.0 67.0 67.0 66.0 67.0 67.0 67.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#10] stanford-crypto-aes Cycles:10 Average:85.00 Median:84.50 stddev:2.36 (2.8%) stddev-sans-first:2.47 05:01:53 INFO - PROCESS | 14898 | Values: 86.0 84.0 83.0 91.0 85.0 84.0 84.0 86.0 83.0 84.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#11] stanford-crypto-ccm Cycles:10 Average:148.20 Median:144.00 stddev:15.81 (11.0%) stddev-sans-first:16.75 05:01:53 INFO - PROCESS | 14898 | Values: 146.0 152.0 141.0 144.0 144.0 142.0 141.0 140.0 192.0 140.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:182.70 Median:182.50 stddev:1.83 (1.0%) stddev-sans-first:1.66 05:01:53 INFO - PROCESS | 14898 | Values: 180.0 182.0 182.0 185.0 186.0 181.0 182.0 184.0 182.0 183.0 05:01:53 INFO - PROCESS | 14898 | 05:01:53 INFO - PROCESS | 14898 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.90 Median:70.00 stddev:1.20 (1.7%) stddev-sans-first:1.22 05:01:53 INFO - PROCESS | 14898 | Values: 69.0 69.0 70.0 70.0 69.0 72.0 69.0 72.0 69.0 70.0 05:01:53 INFO - PROCESS | 14898 | -------- Summary: end -------- 05:01:53 INFO - PROCESS | 14898 | 05:01:55 INFO - TEST-INFO | 14898: exit 0 05:01:55 INFO - TEST-OK | kraken | took 64937ms 05:01:55 INFO - SUITE-END | took 1187s 05:01:55 INFO - Completed test suite (00:19:47) 05:01:55 INFO - javascript benchmark 05:01:55 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2572.459783445476, 2593.533164030474, 2617.947641047179, 2629.4346715456186, 2640.996421359884, 4433.778311084449, 4464.687471876961, 4590.793414296356, 4628.375169352141, 4644.581987621118, 4525.298578720295, 4548.431446069241, 4578.702384345015, 4613.146567884944, 4643.883902902429, 4190.476190476191, 4219.261629214875, 4252.80862361193, 4278.35824626307, 4286.142771445723, 3894.3768996960493, 4266.7439953602725, 4291.871243862689, 4339.088791353804, 4378.890527736816, 4177.394277829698, 4237.87286381409, 4249.277622804131, 4326.351047342892, 4347.869563913072, 4207.705460617758, 4249.192653395876, 4259.659227261812, 4267.0, 4269.786510674454, 4211.810468528924, 4229.471316085489, 4266.509351424595, 4318.611324980736, 4324.783760811947, 4605.677602567822, 4642.883927901796, 4648.3957085578995, 4693.671442998992, 4707.199776038082, 4966.503349665005, 4982.526659967333, 4983.401991760976, 4985.9252111218, 5025.14572522672, 4830.9275360869615, 4901.436334821506, 4906.313116163704, 4924.039812236615, 4997.05056039355, 4650.186217411906, 4679.110968915895, 4683.695559788603, 4726.314684370747, 4728.432588089451, 5096.694198348111, 5099.980003999215, 5106.080905437057, 5106.4382917879, 5152.92270615941, 4645.953540464552, 4654.86035418938, 4895.632827537949, 4902.240152776325, 4945.0, 4853.4418541868135, 4909.410870695539, 4969.105560999054, 4985.825496107619, 5065.189569668909, 4858.902821943541, 4866.46468888422, 4888.6577939543895, 4974.452810190876, 5024.171011783015, 4920.950790492121, 4925.482824303468, 4935.950640493621, 4942.728149951788, 4970.0, 3991.082051128257, 4041.393790931325, 4084.0606660468256, 4134.462519872397, 4138.813753381105, 3597.1366871950545, 3607.206414588786, 3612.1330880588994, 3650.0, 3651.8904432867057, 4281.100968796588, 4286.357046442996, 4290.0, 4322.178786030644, 4338.501072376654, 4812.446568644581, 4855.5387238212315, 4865.221564549655, 4978.477259887732, 4988.052270068675, 4161.10536234711, 4207.158568286355, 4212.178625168124, 4227.556106608823, 4262.062346283813, 4324.891877703082, 4347.695661303742, 4352.651787856964, 4399.780010999501, 4401.1417773534495, 4479.507254202101, 4618.445786505641, 4631.861044168681, 4632.02727427244, 4668.5098064702715, 4815.879603009953, 4876.29293752411, 4884.731339776346, 4951.876203094807, 4952.133376659142, 4687.203175460112, 4689.249720044776, 4705.694129881546, 4718.622510199107, 4732.787024583971, 4867.3915760529935, 4914.2628605708, 4914.483979182134, 4918.114739346809, 4957.82647607332, 4784.665073444826, 4848.587870031087, 4923.384576927884, 4950.183219768698, 4985.900281994413, 4838.564529192389, 4843.2250839865455, 4869.269609558594, 4870.7808148632685, 4891.31521586971, 4802.567768900815, 4841.927371089366, 4843.321934929183, 4845.152098382699, 4874.878128046686, 4612.354270402079, 4665.323528088476, 4733.148033353892, 4793.161196790617, 4815.759212039314, 4871.464138944784, 4925.21196608541, 4939.728314942713, 4968.205087186033, 4972.105021096238, 4647.372604698322, 4791.856244312677, 4816.15717249487, 4860.1251774680895, 4874.098291816025], "value": 4534.971301069074, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [544.0424852260021, 545.2938444714094, 548.4597671293775, 552.9004779139755, 566.7336351914602, 28013.299667508323, 30966.690333096663, 37268.81365593175, 38916.80541597288, 39147.41278880812, 39919.0, 40324.798376008155, 40370.0, 40371.59628403715, 40375.19249615006, 7555.773326800205, 7619.733309334174, 7679.808004799869, 7710.190430004853, 7711.845763084735, 7464.216257292987, 7524.699012039512, 7542.886856697154, 7543.24567543244, 7551.660175292125, 7565.508241964255, 7595.544267343949, 7608.923910760905, 7609.315161635452, 7710.113336966237, 7603.239676032353, 7605.125410577743, 7617.238276172394, 7659.885101723478, 7664.041994750656, 7452.403807695371, 7523.699052037912, 7525.134609519921, 7526.473146879721, 7532.322091011781, 37442.81278593617, 37927.0, 37933.81033094844, 37958.0, 37969.24061518754, 2874.6694130175088, 2972.5986991756054, 2974.3605124898036, 2998.34036511967, 3112.4864397374404, 28222.85888570544, 28290.0, 28409.289767755763, 28743.85628071867, 29902.252443688863, 3228.8547015384365, 3350.7602187190896, 3429.554157959474, 3497.7201823854284, 3535.9469607955903, 241651.0, 243121.0, 243343.0, 243391.0, 243825.0, 32153.51769723456, 33240.66759332376, 33310.83344583261, 33367.66632333694, 53747.73126134344, 32456.188595285308, 32590.837045815093, 32623.347533049207, 32649.347013059607, 32668.346633067682, 12556.623301300975, 12729.427175777113, 12730.045246606542, 12741.872581274069, 12771.744565108645, 10475.266731328733, 10615.84076238857, 10622.097121744739, 10622.20333474977, 10685.893141068489, 7522.924770752223, 7605.581693006827, 7609.6575654095695, 7642.0, 7709.653065612061, 2963.777716671258, 2986.68639792823, 3047.1467988963127, 3049.2986613079115, 3057.5107982722657, 805.2269820971816, 824.5629816197425, 848.6562942008496, 860.3891237221643, 919.0396036142247, 26973.730262697514, 27690.723092768814, 27725.306867328076, 27822.0, 27975.15354828455, 762.3024932187097, 892.7768057985504, 907.0929070929071, 920.8756817829641, 938.9624415023322, 13627.523036693668, 14088.71822563543, 14196.85803141976, 14475.565733028026, 14501.709965800625, 352383.0, 354829.0, 355668.0, 355690.0, 355839.0, 47501.52498474971, 47917.520824792, 47966.5203347969, 47969.28046079312, 47979.5202047975, 1018.1701912941078, 1050.985798704254, 1133.0255979857482, 1138.9031932285682, 1153.4924633161381, 25085.749142508343, 28472.715272847006, 28699.856500717364, 28733.0, 29487.410251794416, 39744.20511589694, 40152.79923600363, 40180.1963960725, 40305.395419069326, 40312.79843600763, 281843.0, 283942.0, 285622.0, 286067.0, 287747.0, 22944.4263893404, 23874.283771486884, 24357.26928192157, 24765.0, 25627.487450251265, 40355.19289614133, 40492.0, 40563.797181013906, 40628.0, 41433.0, 34449.65550344464, 35128.29743405169, 35368.46947295741, 35420.82289588536, 35422.64577354193, 34587.654123458444, 34747.82626086853, 34790.30419391547, 35051.0, 35321.116972075906, 34911.0, 34947.30105397827, 36244.27511449703, 36913.0, 37491.62508374881, 33863.49204761881, 37456.81271593625, 37597.43603845999, 37639.43540846944, 37728.62271377251, 28996.27509312284, 29947.550786737782, 30348.544771827997, 30574.84712576423, 30655.54016689707], "value": 15880.618952944236, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [342.68301820815736, 345.78906866811224, 367.68195510883083, 367.89698884312395, 380.5680552572829, 12423.254604723723, 13479.79780303295, 15272.16003119828, 16580.75128873068, 16686.916565417156, 15689.686206275868, 15841.287142078605, 15991.520254392386, 15999.360025598962, 16083.195840207973, 4874.366332376786, 4882.56056954874, 5032.949670503303, 5053.949460505385, 5066.493350664941, 4917.950820491803, 4975.278584605248, 5086.415062267831, 5267.051930652481, 5294.867628309304, 5350.5452036576935, 5350.598705097113, 5353.277307563488, 5357.705326207057, 5361.892762144755, 5221.425643179247, 5238.345206849144, 5267.5259226669405, 5293.947060529384, 5327.866803329909, 5128.820491282787, 5140.280360749498, 5144.819931302386, 5154.278401023822, 5158.509941555546, 10968.890311096866, 17780.733289000676, 18166.27334906602, 18420.907895460572, 18517.907410462994, 1721.8622510199154, 1786.3926265069808, 1991.9302824401077, 2055.198472595689, 2328.429534763977, 8232.217939295757, 8247.463914845515, 8394.748157555283, 8652.740417787476, 8781.0, 1655.3130450862877, 1714.5426387570465, 1724.6292047209786, 1749.6413235286736, 1818.0182701341391, 66802.3319766801, 67374.3262567373, 67545.0, 68554.0, 69212.30787692108, 9720.270979676552, 9744.464054477072, 9786.266030047633, 10040.0, 10101.898981010243, 13597.796033059512, 13615.931920340336, 13629.114107582975, 13632.454701812016, 13634.52279170244, 6491.902621460682, 6507.8698426031215, 6630.569013014138, 6703.363180497845, 6710.496712746563, 6032.698365081728, 6071.908921366183, 6138.232720909887, 6218.5647004710145, 6250.6874656267, 4223.21870453967, 4239.173361194599, 4263.936040959388, 4347.152305300499, 4357.455318085239, 1761.7885853697637, 1806.3717291341068, 1827.7532533108126, 1851.6111616560672, 1874.4189301316635, 729.9489035767446, 795.6857041468587, 816.5917041479261, 861.9094995025557, 867.6399294292924, 15634.296456659478, 16095.356185752438, 16369.508914732578, 16426.83573164277, 17111.14444277806, 840.1766269056359, 847.3898792869124, 853.3940901959554, 855.5465603230298, 896.3591032411857, 8892.777680558038, 9100.408473449204, 9326.860097098548, 9429.622815087458, 9549.809003819884, 352798.0, 355348.0, 359130.0, 360465.0, 361540.0, 71827.64086179536, 73489.26510734824, 74079.25920740831, 75402.0, 76286.23713762902, 789.5144486140982, 810.562296359959, 812.7642983534708, 815.4862436664863, 815.963281652327, 14386.640333991734, 14562.563123106323, 14584.0, 14606.488772892897, 15166.165860877758, 35382.29235415226, 35958.64041359553, 37020.814895925345, 37027.07432314214, 37177.814110930354, 42999.0, 44901.0, 49128.508714912394, 50533.74733126311, 50831.74584127056, 6230.748312773515, 6712.0, 6736.966315168393, 6802.591844489347, 6933.826654333682, 7980.4812687175145, 10234.33476824004, 10324.328918620266, 10810.081143102925, 10868.565257389615, 9111.453312801254, 9482.905170948477, 9567.9043209567, 9663.178629816544, 9692.9030709692, 8310.127436619068, 8349.874751878606, 8645.870311945451, 8669.91330086691, 8942.150495702897, 8986.68546600866, 9052.773680658036, 9056.683016094668, 9057.728268151966, 9446.480443575394, 6353.745850165941, 6534.8366290843105, 6677.9332206679255, 6750.426213771884, 7313.414926805949, 8920.910790892009, 9027.819443611223, 9048.366614336934, 9058.773530661787, 9434.48110353937], "value": 7693.298190550586, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1220.3227208899068, 1315.8486774020987, 1357.9456821727128, 1401.9299035048246, 1642.4497793239273, 5665.660060396379, 6244.781432649858, 6510.479161667073, 6515.250746164181, 6720.495962802785, 6622.6357550334715, 6686.4316533094625, 6696.933030669692, 6697.464202863772, 6698.095757072793, 1952.882827030379, 1979.6931475621302, 1979.9703004454946, 1981.1580078466593, 1981.7621885373703, 1967.9901600491978, 2035.7760646328893, 2036.063410831012, 2037.0833125093693, 2039.3270220827092, 1957.1388589020785, 1977.4067779666043, 1996.341207401554, 1996.880187188766, 1999.8300144487737, 1977.0806574942649, 1998.6302534031252, 1998.9200431982704, 1999.6100760351737, 2001.3095482058666, 1957.1779852461857, 1994.9601007979759, 1997.0713618167622, 1997.121266642687, 1997.8901160436171, 6395.456386207178, 6479.0, 6525.347465253484, 6550.246721626979, 6574.145361103074, 4001.279769641463, 4180.226658068267, 4180.874573762761, 4183.853565125206, 4192.371144328345, 2528.582783840664, 2658.003248781707, 2708.8374697518016, 2711.18664400679, 2714.267147870064, 875.1817051057282, 894.1326912894482, 894.7807787092204, 1679.5465224389347, 1699.6260822619004, 8629.180227878403, 8643.17889800468, 8676.913230867674, 8694.652213911437, 8696.565171741388, 3286.8824599636237, 3546.6453354664327, 3635.2911182319194, 3637.618050104754, 3651.1419816343137, 6948.861022779516, 6949.791506254821, 6954.0, 6954.826129346807, 6964.965175174092, 4073.124278280184, 4074.2869997750277, 4074.6740260779065, 4075.918481630351, 4078.0824314529586, 3339.0984434203115, 3460.7750496217664, 3606.4229723244157, 3761.3793724035777, 3808.067023579241, 3098.070578826343, 3150.3699260147605, 3242.5622540957143, 3245.837708114585, 3265.1837040739815, 1056.1814593689799, 1085.7177133945231, 1089.4171618184234, 1100.0, 1105.5467258424007, 709.5033476566424, 725.1769241910364, 731.4294850016995, 747.3460721868365, 755.199488542147, 4256.574342565718, 4298.935515967263, 4363.4109395231235, 4431.601155895984, 4500.279955207151, 358.2226568346694, 360.1644185489639, 362.5250921293115, 366.79276208942395, 368.1201927393532, 2984.358362951976, 2987.9701202988126, 2991.3718119194778, 2996.1910284223572, 3077.430675325027, 7195.388391986635, 7614.0, 7839.725609603751, 7931.801704957307, 7932.325752311002, 7488.363489103487, 7605.23947605235, 7615.16233214346, 7615.504992175491, 7616.428767842434, 6088.817335479943, 6258.186435763413, 6266.310705822447, 6268.811935641938, 6270.090836828635, 4456.0, 4509.661775366926, 4552.385427967314, 4610.953890461053, 4778.0, 7085.574865508086, 7178.497505174588, 7297.489175757646, 7400.222976587381, 7499.0, 7246.782596522113, 7483.251674832473, 7506.849863002819, 7506.9249307506225, 7508.324250817453, 5591.6365436246515, 5788.450097240755, 5835.912461312999, 5841.912371314519, 5856.765729370777, 5699.5155411790465, 5891.23413956183, 6151.477124444473, 6351.841203969938, 6355.968220159055, 5912.852178695567, 5941.346451890202, 5945.197398351167, 5953.374895636069, 5989.850253743517, 5850.268716410449, 5852.736626851717, 5892.438503796412, 5929.644221346561, 5962.880742385215, 5315.9468405317, 5359.892802144013, 5385.434529374359, 5389.27244821944, 5398.487143721497, 3892.9805350973065, 3927.587603301612, 3929.528456585228, 3984.7808370539897, 4013.9397909030804, 3822.6177382261553, 3831.885043448701, 3849.7690138591774, 3919.92160156801, 3934.4295077214215], "value": 3537.5768554720908, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [276.34919763955884, 281.0500508282007, 285.6372407043056, 290.90184553311246, 291.96788353281147, 4731.266653668683, 4749.928751068728, 4768.976155119224, 4782.976085119578, 4794.664373493857, 4679.929801052978, 4710.081534100852, 4711.539422778932, 4730.668853180278, 4743.928841067387, 3487.8779242726573, 3566.144125409909, 3607.2424790793966, 3669.4128939369707, 3678.485012098295, 3692.833822477995, 3694.3350196964534, 3699.889003329891, 3706.703463722909, 3711.0536813112617, 3657.4330978698213, 3664.7617904836234, 3668.9816550917208, 3670.541182352206, 3702.759320644163, 3450.8949540780104, 3540.6545512705266, 3556.1109722569227, 3633.9461556148685, 3660.4143337066207, 3221.743520027191, 3223.4036703209745, 3235.2397186661115, 3237.4496335623003, 3237.854296556637, 4550.453945526558, 4565.196747284837, 4581.244094724367, 4589.265717485219, 4590.02628869586, 3881.2237552489332, 4096.160287141129, 4144.254034273829, 4152.27335216339, 4161.605862036222, 4856.514348565115, 4873.610111191097, 4874.585660218886, 4881.170201065792, 4882.654437550583, 3418.538497302857, 3427.326685185559, 3434.6050204226335, 3435.9828200859088, 3441.638627944055, 5048.368953880765, 5140.974295128501, 5182.455842136596, 5185.844424667266, 5196.558292545138, 3512.7892326459983, 3514.332276867387, 3517.3141237458963, 3525.7531972761662, 3538.6815186633326, 3553.342631613108, 3556.3776339141064, 3557.928841423157, 3565.1800085979853, 3565.4117070683565, 4087.7547347159266, 4111.527174374925, 4115.0, 4117.1765646870745, 4117.814698338582, 4724.669273150916, 4878.463369029404, 4945.703257804544, 4965.577925876269, 4970.229614409773, 1188.3464094747853, 1200.7598480303975, 1203.2720204276286, 1204.1811568133578, 1206.9680423238005, 735.9227281135511, 777.9222077792175, 813.7965508622844, 827.6606591297539, 828.5153185386496, 4150.169966006751, 4279.293916503804, 4388.5830846069575, 4400.251957167289, 4400.757958312323, 5039.740064983754, 5047.2429135629945, 5049.267856160836, 5076.568491678248, 5089.262057001714, 4405.31717583775, 4405.603495685404, 4405.691601587858, 4417.116576684676, 4417.690761646654, 2456.82802203844, 2586.5602847515966, 2598.246508512548, 2618.528664840309, 2627.6584044074148, 4641.86074417768, 4644.535546445329, 4660.231061874752, 4670.626349892001, 4672.813087476463, 5032.521910418504, 5042.302368232978, 5043.470435604282, 5052.722100284446, 5080.272707279469, 4390.6630960470275, 4623.4228114166735, 4636.953630463652, 4659.207934651117, 4664.720116793003, 4885.780139893643, 4897.0, 4901.215805471107, 4918.213085906238, 4923.655344125877, 4745.552606455064, 4754.21555443348, 4768.9523104768505, 4819.180739274402, 4844.781984810622, 4429.623482004065, 4591.563801438858, 4611.5619016193405, 4614.861554153381, 4633.096546173464, 3353.849076791599, 3370.7416031259604, 3377.3920694275266, 3390.8643654254543, 3399.320135972766, 4880.463149053672, 4922.310876477224, 4930.630202734881, 4942.703437793743, 4943.431505376928, 4647.9767601161775, 4791.0178413425865, 4830.082284365959, 4933.55597996182, 4993.226049962262, 4919.704817710805, 4951.579115775199, 4960.305557222064, 4984.679060049018, 4987.625928055338, 4886.413630364379, 4896.877578060435, 4912.582430493448, 4916.287138364845, 4937.432195297587, 4859.489753575824, 4976.2038073908, 4994.550490455877, 5033.320501732365, 5049.0, 4856.660033797601, 4888.335856958038, 4893.853184404474, 4896.877578060435, 4917.959046995456], "value": 3661.017159779374, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [605.5882000239841, 606.6814922165862, 621.6145989486519, 633.2938773267805, 726.3172617739325, 13168.078234523588, 13791.172529648227, 13793.172409655428, 13794.65513362164, 13805.447782088717, 12485.68785780356, 12536.686582835433, 12567.183133096343, 12601.62195134145, 12647.494100236003, 600.9459148676618, 616.3866952382385, 739.5858319341173, 762.5005621318018, 764.1250767870785, 732.765515035189, 758.1432980731765, 759.3242014607005, 760.6424980259269, 761.5126319155745, 794.3446656508374, 797.0554892452462, 797.0674311056079, 797.6769408389612, 798.6845196147518, 626.9310375858652, 789.3290702902544, 792.6987744657051, 793.095870707394, 793.2939683681528, 471.02262804680083, 554.2268535393144, 561.1778744139855, 570.7745440551, 572.461885827321, 12134.878651213463, 12236.755264894742, 12251.081168912368, 12313.26120432777, 12397.194182378116, 9357.953210233973, 9692.127708506268, 9760.90239097607, 9965.70102896907, 9970.850437243447, 8612.440191387539, 9010.0, 10941.301665176205, 11222.551097956071, 11229.0, 3169.350283191963, 3186.0919637903085, 3271.4438545447333, 3363.764536482447, 3996.540397854255, 50088.74778130539, 50184.74907625438, 50236.497635023545, 50409.0, 51374.743126284506, 9663.420194788336, 9710.563024663907, 9851.261155413373, 9858.408495490294, 9930.304878658424, 16902.239399227063, 16917.7462338065, 16919.492415227563, 17011.489655310113, 17047.31810727582, 6178.62928224308, 6198.194234749544, 6280.811575652647, 6348.650824204713, 6392.680365981682, 3155.4339716488435, 3178.4278829810855, 3202.5676533668125, 3320.7177389921644, 3400.795952242873, 2723.400851812598, 2926.3854590536225, 2966.347403571211, 2989.6561895381874, 2997.1607949774098, 505.2850216943058, 509.1039770004818, 510.19898758948835, 512.4465577176715, 513.2301547678483, 508.07276719985435, 556.6332124483502, 587.4448646029462, 588.1002066837746, 593.9495142912814, 7618.276263754934, 7890.0, 8102.51384916895, 8209.055958564722, 8856.8671469928, 491.50112635674816, 504.5938019893947, 569.9114690940366, 577.924869766936, 623.43579060949, 3714.108613932691, 3865.3622152344547, 3896.0, 3944.526656801202, 4108.5275193352545, 52795.47204527982, 55519.0, 55616.72191639097, 63034.684826575576, 64815.35184648188, 35650.0, 42122.57877421186, 54649.0, 56694.0, 57371.42628573744, 50275.24587131196, 50416.747916260916, 51176.74411627918, 53866.46133538614, 56656.433435665116, 7866.803329916798, 8069.515829050276, 8166.4283500154415, 8194.34445244391, 8441.746747597583, 36516.0, 37686.81156594199, 37696.0, 38119.618803812715, 38367.808160959015, 44001.55998440103, 46955.53044469511, 47777.522224777305, 49188.75405622949, 51605.741971289906, 10847.620333288298, 10862.248696947134, 10898.18263630215, 11070.667879963614, 11405.543778248777, 11124.165687573626, 11624.593139240085, 11627.709307267385, 11677.824832627348, 11811.350375729417, 10597.0, 11029.805461359896, 11079.0, 11677.474513647076, 11691.532338706696, 9573.904260957579, 9853.113219810251, 9912.14192611167, 10235.897641023494, 10494.632687856194, 10778.137748979905, 10965.780684386427, 11177.497012634289, 11629.651110466699, 11643.88356116462, 8521.403501754818, 8578.0, 8755.0, 8862.246709029547, 9024.36829421934, 8017.799555011172, 8259.752207433787, 8390.28682561989, 8651.95674021626, 8700.347473939353], "value": 5891.161951823042, "unit": "score"}], "name": "dromaeo_css", "value": 5902.274266382164, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 117.0, 117.0, 122.0, 116.0, 117.0, 116.0, 116.0, 118.0, 116.0], "value": 116.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 131.0, 127.0, 166.0, 128.0, 129.0, 130.0, 130.0, 163.0, 128.0], "value": 138.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 162.0, 160.0, 161.0, 160.0, 162.0, 162.0, 160.0, 161.0], "value": 161.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 77.0, 75.0, 108.0, 78.0, 78.0, 78.0, 78.0, 112.0, 77.0], "value": 83.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 110.0, 84.0, 85.0, 84.0, 104.0, 84.0, 84.0, 114.0], "value": 91.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 118.0, 117.0, 118.0, 118.0, 117.0, 118.0, 120.0], "value": 117.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 147.0, 146.0, 146.0, 146.0, 146.0, 147.0, 145.0, 146.0], "value": 146.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 85.0, 85.0, 86.0, 85.0, 85.0, 85.0, 84.0, 85.0], "value": 85.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 63.0, 63.0, 62.0, 64.0, 64.0, 64.0, 64.0, 64.0, 64.0], "value": 63.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 67.0, 66.0, 67.0, 67.0, 66.0, 67.0, 67.0, 67.0], "value": 66.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 84.0, 83.0, 91.0, 85.0, 84.0, 84.0, 86.0, 83.0, 84.0], "value": 85.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 152.0, 141.0, 144.0, 144.0, 142.0, 141.0, 140.0, 192.0, 140.0], "value": 148.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [180.0, 182.0, 182.0, 185.0, 186.0, 181.0, 182.0, 184.0, 182.0, 183.0], "value": 182.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 69.0, 70.0, 70.0, 69.0, 72.0, 69.0, 72.0, 69.0, 70.0], "value": 69.9, "unit": "score"}], "name": "kraken", "value": 1556.2000000000003, "alertThreshold": 2.0}]} 05:01:55 INFO - Return code: 0 05:01:55 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:01:55 INFO - # TBPL SUCCESS # 05:01:55 INFO - Running post-action listener: _resource_record_post_action 05:01:55 INFO - [mozharness: 2016-11-15 13:01:55.414158Z] Finished run-tests step (success) 05:01:55 INFO - Running post-run listener: _resource_record_post_run 05:01:55 INFO - Total resource usage - Wall time: 1204s; CPU: 13.0%; Read bytes: 4096; Write bytes: 390909952; Read time: 12; Write time: 274048 05:01:55 INFO - TinderboxPrint: CPU usage
13.1% 05:01:55 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 05:01:55 INFO - TinderboxPrint: I/O write bytes / time
390,909,952 / 274,048 05:01:55 INFO - TinderboxPrint: CPU idle
8,349.5 (86.9%) 05:01:55 INFO - TinderboxPrint: CPU user
1,208.5 (12.6%) 05:01:55 INFO - TinderboxPrint: Swap in / out
0 / 0 05:01:55 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 99901440; Read time: 0; Write time: 95860 05:01:55 INFO - run-tests - Wall time: 1188s; CPU: 13.0%; Read bytes: 0; Write bytes: 291008512; Read time: 0; Write time: 178188 05:01:56 INFO - Running post-run listener: _upload_blobber_files 05:01:56 INFO - Blob upload gear active. 05:01:56 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:01:56 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 05:01:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:01:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:01:56 INFO - (blobuploader) - INFO - Open directory for files ... 05:01:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:01:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:01:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:01:59 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:01:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:01:59 INFO - (blobuploader) - INFO - Done attempting. 05:01:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 05:02:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:02:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:02:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:02:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:02:00 INFO - (blobuploader) - INFO - Done attempting. 05:02:00 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:02:00 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:02:00 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:02:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:02:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:02:01 INFO - (blobuploader) - INFO - Done attempting. 05:02:01 INFO - (blobuploader) - INFO - Iteration through files over. 05:02:01 INFO - Return code: 0 05:02:01 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:02:01 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:02:01 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/384260a707b283493fe876bac88630e49fb00fd6ae87a88ab47654bea20c170cbbb272f4e2117f20da9b57ee93d156c36c5b02d571efee3d4633c87a0e45ea19", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/50efd088e6f4101892cfc2aa96c0127d0659ebe6f29ca52fc3593768d8091701d92820a8173bc28aaee2d830405dd333ef2cffd6d0b3e7c19ec365903badab86", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/17c913afeefaf06401b7da45d1996e03f65f5d0a68e39c55692c37fa0bf4be3a4b60dab928904b4a28f9f318bd646ad1e3e938a30608d851ec403556c35a142e"} 05:02:01 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:02:01 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:02:01 INFO - Contents: 05:02:01 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/384260a707b283493fe876bac88630e49fb00fd6ae87a88ab47654bea20c170cbbb272f4e2117f20da9b57ee93d156c36c5b02d571efee3d4633c87a0e45ea19", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/50efd088e6f4101892cfc2aa96c0127d0659ebe6f29ca52fc3593768d8091701d92820a8173bc28aaee2d830405dd333ef2cffd6d0b3e7c19ec365903badab86", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/17c913afeefaf06401b7da45d1996e03f65f5d0a68e39c55692c37fa0bf4be3a4b60dab928904b4a28f9f318bd646ad1e3e938a30608d851ec403556c35a142e"} 05:02:01 INFO - Running post-run listener: copy_logs_to_upload_dir 05:02:01 INFO - Copying logs to upload dir... 05:02:01 INFO - mkdir: /builds/slave/test/build/upload/logs 05:02:01 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1249.256325 ========= master_lag: 0.77 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 50 secs) (at 2016-11-15 05:02:02.127074) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-15 05:02:02.132214) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/384260a707b283493fe876bac88630e49fb00fd6ae87a88ab47654bea20c170cbbb272f4e2117f20da9b57ee93d156c36c5b02d571efee3d4633c87a0e45ea19", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/50efd088e6f4101892cfc2aa96c0127d0659ebe6f29ca52fc3593768d8091701d92820a8173bc28aaee2d830405dd333ef2cffd6d0b3e7c19ec365903badab86", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/17c913afeefaf06401b7da45d1996e03f65f5d0a68e39c55692c37fa0bf4be3a4b60dab928904b4a28f9f318bd646ad1e3e938a30608d851ec403556c35a142e"} build_url:https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011738 build_url: 'https://queue.taskcluster.net/v1/task/fMoSUf77QoaHm7Jxh7M5pw/artifacts/public/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/384260a707b283493fe876bac88630e49fb00fd6ae87a88ab47654bea20c170cbbb272f4e2117f20da9b57ee93d156c36c5b02d571efee3d4633c87a0e45ea19", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/50efd088e6f4101892cfc2aa96c0127d0659ebe6f29ca52fc3593768d8091701d92820a8173bc28aaee2d830405dd333ef2cffd6d0b3e7c19ec365903badab86", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/17c913afeefaf06401b7da45d1996e03f65f5d0a68e39c55692c37fa0bf4be3a4b60dab928904b4a28f9f318bd646ad1e3e938a30608d851ec403556c35a142e"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-15 05:02:02.161233) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-15 05:02:02.161679) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=03627c79f6bb3d1578c4a402000001ba-1479211726.310396-1818456240 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004688 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-15 05:02:02.211522) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-15 05:02:02.214913) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-15 05:02:02.215268) ========= ========= Total master_lag: 0.92 =========